[18:55:08.639] New invocation is queued and will start shortly
[18:55:09.852] Starting the invocation (attempt 1)
[18:55:09.878] Popped buildset tag "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/20c92b363d7ad7e4993c186509f08f4679f53db6"
[18:55:09.878] Popped gitiles commit info from properties and tags
[18:55:09.879] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[18:55:09.879] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[18:55:09.879] Buildbucket request:
{
"requestId": "8945892708660079040",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "ToTWin(dll)"
},
"properties": {
},
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "20c92b363d7ad7e4993c186509f08f4679f53db6",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8945892708660079040"
},
{
"key": "scheduler_job_id",
"value": "chromium/ToTWin(dll)"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[18:55:10.270] Scheduled build:
{
"id": "8780462646639752993",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "ToTWin(dll)"
},
"number": 12871,
"createdBy": "project:chromium",
"createTime": "2023-05-21T18:55:09.943037543Z",
"updateTime": "2023-05-21T18:55:09.943037543Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "20c92b363d7ad7e4993c186509f08f4679f53db6",
"ref": "refs/heads/main"
}
}
}
[18:55:10.270] Task URL: https://cr-buildbucket.appspot.com/build/8780462646639752993
[18:55:10.270] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:2:0) after 2m44s
[18:57:54.292] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:2:0)
[18:57:54.375] Build status: SCHEDULED
[18:57:54.375] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:3:0) after 6m45s
[19:00:35.975] Received PubSub notification, asking Buildbucket for the build status
[19:00:36.007] Build status: STARTED
[19:04:39.395] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:3:0)
[19:04:39.413] Build status: STARTED
[19:04:39.413] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:5:0) after 3m54s
[19:08:33.444] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:5:0)
[19:08:33.463] Build status: STARTED
[19:08:33.463] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:6:0) after 1m40s
[19:10:13.480] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:6:0)
[19:10:13.508] Build status: STARTED
[19:10:13.508] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:7:0) after 8m31s
[19:18:44.561] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:7:0)
[19:18:44.579] Build status: STARTED
[19:18:44.579] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:8:0) after 5m15s
[19:23:59.808] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:8:0)
[19:23:59.832] Build status: STARTED
[19:23:59.832] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:9:0) after 6m10s
[19:30:10.147] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:9:0)
[19:30:10.200] Build status: STARTED
[19:30:10.200] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:10:0) after 9m50s
[19:40:00.320] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:10:0)
[19:40:00.340] Build status: STARTED
[19:40:00.340] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:11:0) after 1m2s
[19:41:02.385] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:11:0)
[19:41:02.405] Build status: STARTED
[19:41:02.405] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:12:0) after 5m34s
[19:46:36.805] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:12:0)
[19:46:36.827] Build status: STARTED
[19:46:36.827] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:13:0) after 6m12s
[19:52:48.853] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:13:0)
[19:52:48.874] Build status: STARTED
[19:52:48.874] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:14:0) after 9m37s
[20:02:25.894] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:14:0)
[20:02:25.913] Build status: STARTED
[20:02:25.913] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:15:0) after 4m5s
[20:06:31.576] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:15:0)
[20:06:31.596] Build status: STARTED
[20:06:31.596] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:16:0) after 9m30s
[20:16:01.895] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:16:0)
[20:16:01.915] Build status: STARTED
[20:16:01.915] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:17:0) after 6m23s
[20:22:25.357] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:17:0)
[20:22:25.377] Build status: STARTED
[20:22:25.377] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:18:0) after 1m23s
[20:23:48.813] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:18:0)
[20:23:48.830] Build status: STARTED
[20:23:48.830] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:19:0) after 7m8s
[20:30:57.304] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:19:0)
[20:30:57.323] Build status: STARTED
[20:30:57.323] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:20:0) after 1m3s
[20:32:00.350] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:20:0)
[20:32:00.372] Build status: STARTED
[20:32:00.372] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:21:0) after 8m34s
[20:40:34.607] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:21:0)
[20:40:34.631] Build status: STARTED
[20:40:34.631] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:22:0) after 4m29s
[20:45:03.744] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:22:0)
[20:45:03.767] Build status: STARTED
[20:45:03.767] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:23:0) after 5m2s
[20:50:06.026] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:23:0)
[20:50:06.048] Build status: STARTED
[20:50:06.048] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:24:0) after 2m14s
[20:52:20.069] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:24:0)
[20:52:20.094] Build status: STARTED
[20:52:20.094] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:25:0) after 6m27s
[20:58:48.264] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:25:0)
[20:58:48.287] Build status: STARTED
[20:58:48.287] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:26:0) after 3m0s
[21:01:48.619] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:26:0)
[21:01:48.641] Build status: STARTED
[21:01:48.641] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:27:0) after 1m29s
[21:03:17.640] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:27:0)
[21:03:17.660] Build status: STARTED
[21:03:17.660] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:28:0) after 7m40s
[21:10:57.681] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:28:0)
[21:10:57.700] Build status: STARTED
[21:10:57.700] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:29:0) after 9m42s
[21:20:39.857] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:29:0)
[21:20:39.875] Build status: STARTED
[21:20:39.875] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:30:0) after 1m43s
[21:22:22.984] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:30:0)
[21:22:23.005] Build status: STARTED
[21:22:23.005] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:31:0) after 8m5s
[21:30:28.033] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:31:0)
[21:30:28.051] Build status: STARTED
[21:30:28.051] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:32:0) after 7m47s
[21:38:15.211] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:32:0)
[21:38:15.230] Build status: STARTED
[21:38:15.230] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:33:0) after 2m17s
[21:40:32.252] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:33:0)
[21:40:32.300] Build status: STARTED
[21:40:32.300] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:34:0) after 1m11s
[21:41:43.423] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:34:0)
[21:41:43.447] Build status: STARTED
[21:41:43.447] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:35:0) after 6m10s
[21:47:53.483] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:35:0)
[21:47:53.518] Build status: STARTED
[21:47:53.518] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:36:0) after 5m24s
[21:53:17.672] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:36:0)
[21:53:17.695] Build status: STARTED
[21:53:17.695] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:37:0) after 1m29s
[21:54:46.788] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:37:0)
[21:54:46.807] Build status: STARTED
[21:54:46.807] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:38:0) after 7m30s
[22:02:17.775] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:38:0)
[22:02:17.814] Build status: STARTED
[22:02:17.814] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:39:0) after 7m56s
[22:10:13.843] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:39:0)
[22:10:13.864] Build status: STARTED
[22:10:13.864] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:40:0) after 6m3s
[22:16:16.883] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:40:0)
[22:16:16.996] Build status: STARTED
[22:16:16.996] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:41:0) after 6m18s
[22:22:35.025] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:41:0)
[22:22:35.051] Build status: STARTED
[22:22:35.051] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:42:0) after 5m45s
[22:28:20.142] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:42:0)
[22:28:20.161] Build status: STARTED
[22:28:20.161] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:43:0) after 9m5s
[22:37:25.403] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:43:0)
[22:37:25.422] Build status: STARTED
[22:37:25.422] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:44:0) after 4m4s
[22:41:29.580] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:44:0)
[22:41:29.603] Build status: STARTED
[22:41:29.603] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:45:0) after 3m10s
[22:44:39.643] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:45:0)
[22:44:39.667] Build status: STARTED
[22:44:39.667] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:46:0) after 6m50s
[22:51:30.221] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:46:0)
[22:51:30.260] Build status: STARTED
[22:51:30.260] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:47:0) after 6m12s
[22:57:42.515] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:47:0)
[22:57:42.536] Build status: STARTED
[22:57:42.536] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:48:0) after 9m12s
[23:06:54.571] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:48:0)
[23:06:54.589] Build status: STARTED
[23:06:54.589] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:49:0) after 4m50s
[23:11:44.890] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:49:0)
[23:11:44.913] Build status: STARTED
[23:11:44.913] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:50:0) after 7m18s
[23:19:02.932] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:50:0)
[23:19:02.948] Build status: STARTED
[23:19:02.948] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:51:0) after 2m19s
[23:21:22.151] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:51:0)
[23:21:22.194] Build status: STARTED
[23:21:22.194] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:52:0) after 2m44s
[23:24:06.222] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:52:0)
[23:24:06.240] Build status: STARTED
[23:24:06.240] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:53:0) after 8m51s
[23:32:57.499] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:53:0)
[23:32:57.542] Build status: STARTED
[23:32:57.542] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:54:0) after 5m35s
[23:38:32.694] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:54:0)
[23:38:32.724] Build status: STARTED
[23:38:32.724] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:55:0) after 8m54s
[23:47:26.863] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:55:0)
[23:47:26.908] Build status: STARTED
[23:47:26.909] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:56:0) after 9m14s
[23:56:41.423] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:56:0)
[23:56:41.446] Build status: STARTED
[23:56:41.446] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:57:0) after 7m54s
[00:04:35.564] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:57:0)
[00:04:35.589] Build status: STARTED
[00:04:35.589] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:58:0) after 6m48s
[00:11:23.716] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:58:0)
[00:11:23.734] Build status: STARTED
[00:11:23.734] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:59:0) after 8m7s
[00:19:30.763] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:59:0)
[00:19:30.786] Build status: STARTED
[00:19:30.786] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:60:0) after 4m12s
[00:23:42.882] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:60:0)
[00:23:42.909] Build status: STARTED
[00:23:42.909] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:61:0) after 1m22s
[00:25:04.940] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:61:0)
[00:25:04.965] Build status: STARTED
[00:25:04.965] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:62:0) after 5m34s
[00:30:39.132] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:62:0)
[00:30:39.153] Build status: STARTED
[00:30:39.153] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:63:0) after 2m26s
[00:33:05.184] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:63:0)
[00:33:05.209] Build status: STARTED
[00:33:05.209] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:64:0) after 2m52s
[00:35:57.370] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:64:0)
[00:35:57.388] Build status: STARTED
[00:35:57.388] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:65:0) after 1m13s
[00:37:10.546] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:65:0)
[00:37:10.564] Build status: STARTED
[00:37:10.564] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:66:0) after 5m40s
[00:42:50.612] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:66:0)
[00:42:50.633] Build status: STARTED
[00:42:50.633] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:67:0) after 2m7s
[00:44:57.671] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:67:0)
[00:44:57.697] Build status: STARTED
[00:44:57.697] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:68:0) after 3m31s
[00:48:28.731] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:68:0)
[00:48:28.751] Build status: STARTED
[00:48:28.751] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:69:0) after 7m42s
[00:56:10.927] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:69:0)
[00:56:10.950] Build status: STARTED
[00:56:10.950] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:70:0) after 6m58s
[01:03:08.969] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:70:0)
[01:03:08.990] Build status: STARTED
[01:03:08.990] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:71:0) after 2m50s
[01:05:59.036] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:71:0)
[01:05:59.057] Build status: STARTED
[01:05:59.057] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:72:0) after 1m5s
[01:07:04.031] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:72:0)
[01:07:04.054] Build status: STARTED
[01:07:04.054] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:73:0) after 3m39s
[01:10:43.152] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:73:0)
[01:10:43.172] Build status: STARTED
[01:10:43.172] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:74:0) after 7m24s
[01:18:07.209] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:74:0)
[01:18:07.227] Build status: STARTED
[01:18:07.227] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:75:0) after 3m23s
[01:21:30.308] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:75:0)
[01:21:30.332] Build status: STARTED
[01:21:30.332] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:76:0) after 9m7s
[01:30:37.358] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:76:0)
[01:30:37.378] Build status: STARTED
[01:30:37.378] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:77:0) after 3m1s
[01:33:38.558] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:77:0)
[01:33:38.582] Build status: STARTED
[01:33:38.582] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:78:0) after 6m47s
[01:40:25.692] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:78:0)
[01:40:25.726] Build status: STARTED
[01:40:25.726] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:79:0) after 1m18s
[01:41:43.747] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:79:0)
[01:41:43.764] Build status: STARTED
[01:41:43.764] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:80:0) after 7m31s
[01:49:15.006] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:80:0)
[01:49:15.027] Build status: STARTED
[01:49:15.027] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:81:0) after 7m58s
[01:57:13.048] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:81:0)
[01:57:13.081] Build status: STARTED
[01:57:13.081] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:82:0) after 8m44s
[02:05:57.152] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:82:0)
[02:05:57.170] Build status: STARTED
[02:05:57.170] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:83:0) after 2m45s
[02:08:42.202] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:83:0)
[02:08:42.222] Build status: STARTED
[02:08:42.222] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:84:0) after 3m3s
[02:11:45.247] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:84:0)
[02:11:45.275] Build status: STARTED
[02:11:45.275] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:85:0) after 4m41s
[02:16:26.341] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:85:0)
[02:16:26.363] Build status: STARTED
[02:16:26.363] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:86:0) after 2m10s
[02:18:36.488] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:86:0)
[02:18:36.510] Build status: STARTED
[02:18:36.510] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:87:0) after 4m8s
[02:22:44.791] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:87:0)
[02:22:44.812] Build status: STARTED
[02:22:44.812] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:88:0) after 9m6s
[02:31:50.892] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:88:0)
[02:31:50.971] Build status: STARTED
[02:31:50.971] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:89:0) after 7m33s
[02:39:24.028] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:89:0)
[02:39:24.046] Build status: STARTED
[02:39:24.046] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:90:0) after 7m2s
[02:46:26.501] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:90:0)
[02:46:26.520] Build status: STARTED
[02:46:26.520] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:91:0) after 4m46s
[02:51:12.503] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:91:0)
[02:51:12.527] Build status: STARTED
[02:51:12.527] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:92:0) after 3m53s
[02:55:05.546] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:92:0)
[02:55:05.588] Build status: STARTED
[02:55:05.588] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:93:0) after 9m28s
[03:04:33.701] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:93:0)
[03:04:33.722] Build status: STARTED
[03:04:33.722] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:94:0) after 2m12s
[03:06:45.966] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:94:0)
[03:06:45.991] Build status: STARTED
[03:06:45.991] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:95:0) after 2m58s
[03:09:44.011] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:95:0)
[03:09:44.036] Build status: STARTED
[03:09:44.036] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:96:0) after 5m44s
[03:15:28.188] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:96:0)
[03:15:28.209] Build status: STARTED
[03:15:28.209] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:97:0) after 1m58s
[03:17:26.329] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:97:0)
[03:17:26.362] Build status: STARTED
[03:17:26.362] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:98:0) after 3m25s
[03:20:51.381] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:98:0)
[03:20:51.405] Build status: STARTED
[03:20:51.406] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:99:0) after 1m34s
[03:22:25.426] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:99:0)
[03:22:25.451] Build status: STARTED
[03:22:25.451] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:100:0) after 9m23s
[03:31:48.471] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:100:0)
[03:31:48.502] Build status: STARTED
[03:31:48.502] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:101:0) after 6m18s
[03:38:06.545] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:101:0)
[03:38:06.583] Build status: STARTED
[03:38:06.583] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:102:0) after 1m32s
[03:39:38.705] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:102:0)
[03:39:38.738] Build status: STARTED
[03:39:38.738] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:103:0) after 9m46s
[03:49:24.760] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:103:0)
[03:49:24.777] Build status: STARTED
[03:49:24.777] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:104:0) after 8m1s
[03:57:25.798] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:104:0)
[03:57:25.820] Build status: STARTED
[03:57:25.820] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:105:0) after 4m32s
[04:01:57.838] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:105:0)
[04:01:57.910] Build status: STARTED
[04:01:57.910] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:106:0) after 6m2s
[04:07:59.931] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:106:0)
[04:07:59.962] Build status: STARTED
[04:07:59.962] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:107:0) after 8m18s
[04:16:17.948] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:107:0)
[04:16:17.969] Build status: STARTED
[04:16:17.969] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:108:0) after 2m48s
[04:19:06.069] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:108:0)
[04:19:06.094] Build status: STARTED
[04:19:06.094] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:109:0) after 3m31s
[04:22:37.180] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:109:0)
[04:22:37.200] Build status: STARTED
[04:22:37.200] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:110:0) after 4m52s
[04:27:29.375] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:110:0)
[04:27:29.395] Build status: STARTED
[04:27:29.395] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:111:0) after 7m28s
[04:34:57.412] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:111:0)
[04:34:57.433] Build status: STARTED
[04:34:57.433] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:112:0) after 5m26s
[04:40:23.462] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:112:0)
[04:40:23.483] Build status: STARTED
[04:40:23.483] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:113:0) after 9m0s
[04:49:23.582] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:113:0)
[04:49:23.611] Build status: STARTED
[04:49:23.611] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:114:0) after 4m44s
[04:54:07.728] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:114:0)
[04:54:07.746] Build status: STARTED
[04:54:07.746] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:115:0) after 1m47s
[04:55:54.807] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:115:0)
[04:55:54.829] Build status: STARTED
[04:55:54.829] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:116:0) after 5m41s
[05:01:35.849] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:116:0)
[05:01:35.871] Build status: STARTED
[05:01:35.872] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:117:0) after 8m12s
[05:09:47.893] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:117:0)
[05:09:47.915] Build status: STARTED
[05:09:47.915] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:118:0) after 7m39s
[05:17:27.003] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:118:0)
[05:17:27.025] Build status: STARTED
[05:17:27.025] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:119:0) after 1m46s
[05:19:13.125] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:119:0)
[05:19:13.147] Build status: STARTED
[05:19:13.147] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:120:0) after 6m11s
[05:25:24.309] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:120:0)
[05:25:24.329] Build status: STARTED
[05:25:24.329] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:121:0) after 3m38s
[05:29:02.362] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:121:0)
[05:29:02.397] Build status: STARTED
[05:29:02.397] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:122:0) after 9m30s
[05:38:32.477] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:122:0)
[05:38:32.521] Build status: STARTED
[05:38:32.521] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:123:0) after 3m30s
[05:42:02.627] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:123:0)
[05:42:02.650] Build status: STARTED
[05:42:02.650] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:124:0) after 8m26s
[05:50:28.676] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:124:0)
[05:50:28.715] Build status: STARTED
[05:50:28.715] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:125:0) after 7m51s
[05:58:19.951] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:125:0)
[05:58:19.972] Build status: STARTED
[05:58:19.972] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8945892708660079040:126:0) after 6m30s
[06:00:49.473] Received PubSub notification, asking Buildbucket for the build status
[06:00:49.494] Build:
{
"id": "8780462646639752993",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "ToTWin(dll)"
},
"number": 12871,
"createdBy": "project:chromium",
"createTime": "2023-05-21T18:55:09.943037543Z",
"startTime": "2023-05-21T19:00:34.173733Z",
"endTime": "2023-05-22T06:00:49.064146946Z",
"updateTime": "2023-05-22T06:00:49.064146946Z",
"status": "FAILURE",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "20c92b363d7ad7e4993c186509f08f4679f53db6",
"ref": "refs/heads/main"
}
}
}
[06:00:49.494] Invocation finished in 11h5m40.861857665s with status FAILED