[15:51:08.327] New invocation is queued and will start shortly
[15:51:09.426] Starting the invocation (attempt 1)
[15:51:09.497] Popped buildset tag "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/78198907c9adb1866b94d6d5f9b5f93ae01a6b96"
[15:51:09.497] Popped gitiles commit info from properties and tags
[15:51:09.497] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[15:51:09.497] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[15:51:09.497] Buildbucket request:
{
"requestId": "8985042174758405840",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "ToTWin(dll)"
},
"properties": {
},
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "78198907c9adb1866b94d6d5f9b5f93ae01a6b96",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8985042174758405840"
},
{
"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"
}
}
[15:51:10.216] Scheduled build:
{
"id": "8819612112796450353",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "ToTWin(dll)"
},
"number": 9929,
"createdBy": "project:chromium",
"createTime": "2022-03-15T15:51:09.568282067Z",
"updateTime": "2022-03-15T15:51:09.568282067Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "78198907c9adb1866b94d6d5f9b5f93ae01a6b96",
"ref": "refs/heads/main"
}
}
}
[15:51:10.216] Task URL: https://cr-buildbucket.appspot.com/build/8819612112796450353
[15:51:10.216] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:2:0) after 1m34s
[15:52:44.241] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:2:0)
[15:52:44.270] Build status: SCHEDULED
[15:52:44.270] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:3:0) after 1m11s
[15:53:55.295] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:3:0)
[15:53:55.324] Build status: SCHEDULED
[15:53:55.324] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:4:0) after 5m25s
[15:59:20.488] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:4:0)
[15:59:20.522] Build status: SCHEDULED
[15:59:20.522] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:5:0) after 8m20s
[16:07:40.846] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:5:0)
[16:07:40.885] Build status: SCHEDULED
[16:07:40.885] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:6:0) after 5m36s
[16:13:17.323] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:6:0)
[16:13:17.346] Build status: SCHEDULED
[16:13:17.346] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:7:0) after 1m47s
[16:15:04.524] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:7:0)
[16:15:04.544] Build status: SCHEDULED
[16:15:04.545] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:8:0) after 9m55s
[16:24:59.960] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:8:0)
[16:24:59.983] Build status: SCHEDULED
[16:24:59.983] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:9:0) after 8m44s
[16:33:44.084] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:9:0)
[16:33:44.118] Build status: SCHEDULED
[16:33:44.118] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:10:0) after 1m17s
[16:35:01.889] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:10:0)
[16:35:01.952] Build status: SCHEDULED
[16:35:01.952] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:11:0) after 2m37s
[16:37:39.032] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:11:0)
[16:37:39.068] Build status: SCHEDULED
[16:37:39.068] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:12:0) after 9m2s
[16:46:41.139] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:12:0)
[16:46:41.173] Build status: SCHEDULED
[16:46:41.173] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:13:0) after 7m10s
[16:53:51.192] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:13:0)
[16:53:51.216] Build status: SCHEDULED
[16:53:51.216] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:14:0) after 7m35s
[17:01:26.553] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:14:0)
[17:01:26.574] Build status: SCHEDULED
[17:01:26.574] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:15:0) after 2m54s
[17:04:20.598] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:15:0)
[17:04:20.621] Build status: SCHEDULED
[17:04:20.621] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:16:0) after 8m37s
[17:12:57.801] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:16:0)
[17:12:57.827] Build status: SCHEDULED
[17:12:57.827] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:17:0) after 2m27s
[17:15:24.854] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:17:0)
[17:15:24.878] Build status: SCHEDULED
[17:15:24.878] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:18:0) after 8m14s
[17:20:29.649] Received PubSub notification, asking Buildbucket for the build status
[17:20:29.676] Build status: STARTED
[17:23:38.950] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:18:0)
[17:23:38.969] Build status: STARTED
[17:23:38.969] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:20:0) after 5m3s
[17:28:41.993] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:20:0)
[17:28:42.014] Build status: STARTED
[17:28:42.014] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:21:0) after 3m7s
[17:31:49.101] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:21:0)
[17:31:49.280] Build status: STARTED
[17:31:49.280] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:22:0) after 5m31s
[17:37:20.308] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:22:0)
[17:37:20.329] Build status: STARTED
[17:37:20.329] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:23:0) after 1m19s
[17:38:39.343] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:23:0)
[17:38:39.367] Build status: STARTED
[17:38:39.367] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:24:0) after 2m51s
[17:41:30.400] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:24:0)
[17:41:30.419] Build status: STARTED
[17:41:30.419] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:25:0) after 4m26s
[17:45:56.559] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:25:0)
[17:45:56.591] Build status: STARTED
[17:45:56.591] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:26:0) after 5m6s
[17:51:02.630] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:26:0)
[17:51:02.786] Build status: STARTED
[17:51:02.786] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:27:0) after 4m5s
[17:55:07.810] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:27:0)
[17:55:07.856] Build status: STARTED
[17:55:07.856] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:28:0) after 4m7s
[17:59:14.940] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:28:0)
[17:59:14.971] Build status: STARTED
[17:59:14.971] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:29:0) after 4m7s
[18:03:22.027] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:29:0)
[18:03:22.045] Build status: STARTED
[18:03:22.045] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:30:0) after 7m16s
[18:10:38.104] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:30:0)
[18:10:38.124] Build status: STARTED
[18:10:38.124] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:31:0) after 1m25s
[18:12:03.148] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:31:0)
[18:12:03.263] Build status: STARTED
[18:12:03.263] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:32:0) after 8m22s
[18:20:25.288] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:32:0)
[18:20:25.309] Build status: STARTED
[18:20:25.309] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:33:0) after 5m23s
[18:25:48.950] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:33:0)
[18:25:49.338] Build status: STARTED
[18:25:49.338] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:34:0) after 7m8s
[18:32:57.387] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:34:0)
[18:32:57.407] Build status: STARTED
[18:32:57.407] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:35:0) after 2m31s
[18:35:28.612] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:35:0)
[18:35:28.642] Build status: STARTED
[18:35:28.642] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:36:0) after 1m39s
[18:37:07.791] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:36:0)
[18:37:07.814] Build status: STARTED
[18:37:07.814] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:37:0) after 6m15s
[18:43:22.843] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:37:0)
[18:43:22.864] Build status: STARTED
[18:43:22.864] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:38:0) after 8m54s
[18:52:16.897] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:38:0)
[18:52:16.920] Build status: STARTED
[18:52:16.920] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:39:0) after 8m9s
[19:00:25.945] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:39:0)
[19:00:26.055] Build status: STARTED
[19:00:26.055] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:40:0) after 1m0s
[19:01:26.094] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:40:0)
[19:01:26.148] Build status: STARTED
[19:01:26.148] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:41:0) after 3m21s
[19:04:47.452] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:41:0)
[19:04:47.488] Build status: STARTED
[19:04:47.488] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:42:0) after 4m14s
[19:09:01.855] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:42:0)
[19:09:01.876] Build status: STARTED
[19:09:01.876] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:43:0) after 5m52s
[19:14:53.904] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:43:0)
[19:14:53.925] Build status: STARTED
[19:14:53.925] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:44:0) after 7m59s
[19:22:53.031] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:44:0)
[19:22:53.054] Build status: STARTED
[19:22:53.054] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:45:0) after 8m45s
[19:31:38.334] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:45:0)
[19:31:38.361] Build status: STARTED
[19:31:38.361] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:46:0) after 6m22s
[19:38:00.572] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:46:0)
[19:38:00.594] Build status: STARTED
[19:38:00.594] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:47:0) after 5m58s
[19:43:58.629] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:47:0)
[19:43:58.657] Build status: STARTED
[19:43:58.657] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:48:0) after 7m35s
[19:51:33.901] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:48:0)
[19:51:33.922] Build status: STARTED
[19:51:33.922] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:49:0) after 5m8s
[19:56:42.027] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:49:0)
[19:56:42.058] Build status: STARTED
[19:56:42.058] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:50:0) after 6m3s
[20:02:45.116] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:50:0)
[20:02:45.143] Build status: STARTED
[20:02:45.143] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:51:0) after 6m2s
[20:08:47.221] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:51:0)
[20:08:47.249] Build status: STARTED
[20:08:47.249] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:52:0) after 9m33s
[20:18:20.284] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:52:0)
[20:18:20.323] Build status: STARTED
[20:18:20.323] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:53:0) after 2m26s
[20:20:46.419] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:53:0)
[20:20:46.460] Build status: STARTED
[20:20:46.460] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:54:0) after 1m32s
[20:22:18.754] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:54:0)
[20:22:18.788] Build status: STARTED
[20:22:18.788] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:55:0) after 1m25s
[20:23:43.950] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:55:0)
[20:23:44.033] Build status: STARTED
[20:23:44.033] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:56:0) after 2m8s
[20:25:52.328] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:56:0)
[20:25:52.362] Build status: STARTED
[20:25:52.362] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:57:0) after 3m36s
[20:29:28.390] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:57:0)
[20:29:28.411] Build status: STARTED
[20:29:28.411] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:58:0) after 1m28s
[20:30:56.483] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:58:0)
[20:30:56.509] Build status: STARTED
[20:30:56.509] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:59:0) after 6m45s
[20:37:41.598] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:59:0)
[20:37:41.623] Build status: STARTED
[20:37:41.623] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:60:0) after 2m15s
[20:39:57.174] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:60:0)
[20:39:57.201] Build status: STARTED
[20:39:57.201] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:61:0) after 8m19s
[20:48:16.398] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:61:0)
[20:48:16.494] Build status: STARTED
[20:48:16.494] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:62:0) after 8m19s
[20:56:35.525] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:62:0)
[20:56:35.554] Build status: STARTED
[20:56:35.554] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:63:0) after 8m43s
[21:05:18.641] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:63:0)
[21:05:18.663] Build status: STARTED
[21:05:18.663] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:64:0) after 8m21s
[21:13:39.776] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:64:0)
[21:13:39.799] Build status: STARTED
[21:13:39.799] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:65:0) after 7m28s
[21:21:07.774] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:65:0)
[21:21:07.800] Build status: STARTED
[21:21:07.800] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:66:0) after 8m56s
[21:30:03.928] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:66:0)
[21:30:03.973] Build status: STARTED
[21:30:03.973] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:67:0) after 7m30s
[21:37:34.025] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:67:0)
[21:37:34.047] Build status: STARTED
[21:37:34.047] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:68:0) after 5m37s
[21:43:11.094] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:68:0)
[21:43:11.126] Build status: STARTED
[21:43:11.126] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:69:0) after 3m4s
[21:46:15.147] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:69:0)
[21:46:15.174] Build status: STARTED
[21:46:15.174] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:70:0) after 3m43s
[21:49:58.338] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:70:0)
[21:49:58.365] Build status: STARTED
[21:49:58.365] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:71:0) after 7m16s
[21:57:14.403] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:71:0)
[21:57:14.443] Build status: STARTED
[21:57:14.443] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:72:0) after 8m10s
[22:05:24.475] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:72:0)
[22:05:24.501] Build status: STARTED
[22:05:24.501] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:73:0) after 4m24s
[22:09:48.758] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:73:0)
[22:09:48.780] Build status: STARTED
[22:09:48.780] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:74:0) after 8m56s
[22:18:44.881] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:74:0)
[22:18:44.955] Build status: STARTED
[22:18:44.956] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:75:0) after 8m16s
[22:27:01.163] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:75:0)
[22:27:01.188] Build status: STARTED
[22:27:01.188] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:76:0) after 1m50s
[22:28:51.214] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:76:0)
[22:28:51.248] Build status: STARTED
[22:28:51.248] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:77:0) after 8m58s
[22:37:49.279] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:77:0)
[22:37:49.309] Build status: STARTED
[22:37:49.309] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:78:0) after 2m46s
[22:40:36.035] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:78:0)
[22:40:36.059] Build status: STARTED
[22:40:36.059] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:79:0) after 1m49s
[22:42:25.198] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:79:0)
[22:42:25.225] Build status: STARTED
[22:42:25.225] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:80:0) after 3m32s
[22:45:57.314] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:80:0)
[22:45:57.339] Build status: STARTED
[22:45:57.339] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:81:0) after 7m58s
[22:53:55.383] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:81:0)
[22:53:55.405] Build status: STARTED
[22:53:55.405] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:82:0) after 3m2s
[22:56:57.635] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:82:0)
[22:56:57.675] Build status: STARTED
[22:56:57.675] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:83:0) after 9m59s
[23:06:56.699] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:83:0)
[23:06:56.735] Build status: STARTED
[23:06:56.735] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:84:0) after 7m53s
[23:14:50.146] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:84:0)
[23:14:50.172] Build status: STARTED
[23:14:50.172] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:85:0) after 3m10s
[23:18:00.334] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:85:0)
[23:18:00.358] Build status: STARTED
[23:18:00.358] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:86:0) after 5m31s
[23:23:31.609] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:86:0)
[23:23:31.630] Build status: STARTED
[23:23:31.630] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:87:0) after 6m30s
[23:30:01.830] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:87:0)
[23:30:01.876] Build status: STARTED
[23:30:01.876] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:88:0) after 7m11s
[23:37:13.054] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:88:0)
[23:37:13.078] Build status: STARTED
[23:37:13.078] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:89:0) after 5m10s
[23:42:23.207] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:89:0)
[23:42:23.242] Build status: STARTED
[23:42:23.242] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:90:0) after 6m17s
[23:48:40.783] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:90:0)
[23:48:40.817] Build status: STARTED
[23:48:40.817] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:91:0) after 3m28s
[23:52:08.845] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:91:0)
[23:52:08.873] Build status: STARTED
[23:52:08.873] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:92:0) after 2m45s
[23:54:53.901] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:92:0)
[23:54:53.969] Build status: STARTED
[23:54:53.969] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:93:0) after 4m45s
[23:59:39.188] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:93:0)
[23:59:39.209] Build status: STARTED
[23:59:39.209] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:94:0) after 9m8s
[00:08:47.366] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:94:0)
[00:08:47.411] Build status: STARTED
[00:08:47.411] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:95:0) after 5m15s
[00:14:02.493] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:95:0)
[00:14:02.529] Build status: STARTED
[00:14:02.529] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:96:0) after 1m28s
[00:15:30.654] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:96:0)
[00:15:30.688] Build status: STARTED
[00:15:30.688] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:97:0) after 1m0s
[00:16:30.699] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:97:0)
[00:16:30.726] Build status: STARTED
[00:16:30.726] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:98:0) after 2m29s
[00:18:59.831] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:98:0)
[00:18:59.861] Build status: STARTED
[00:18:59.861] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:99:0) after 5m11s
[00:24:10.989] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:99:0)
[00:24:11.010] Build status: STARTED
[00:24:11.010] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:100:0) after 2m20s
[00:26:31.244] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:100:0)
[00:26:31.291] Build status: STARTED
[00:26:31.291] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:101:0) after 9m50s
[00:36:21.360] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:101:0)
[00:36:21.419] Build status: STARTED
[00:36:21.419] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:102:0) after 1m48s
[00:38:09.451] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:102:0)
[00:38:09.490] Build status: STARTED
[00:38:09.490] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:103:0) after 1m39s
[00:39:48.559] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:103:0)
[00:39:48.590] Build status: STARTED
[00:39:48.590] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:104:0) after 3m37s
[00:43:25.660] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:104:0)
[00:43:25.685] Build status: STARTED
[00:43:25.685] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:105:0) after 8m18s
[00:51:43.958] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:105:0)
[00:51:43.982] Build status: STARTED
[00:51:43.982] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:106:0) after 9m2s
[01:00:46.359] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:106:0)
[01:00:46.469] Build status: STARTED
[01:00:46.469] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:107:0) after 9m16s
[01:10:02.645] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:107:0)
[01:10:02.666] Build status: STARTED
[01:10:02.666] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:108:0) after 2m42s
[01:12:44.694] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:108:0)
[01:12:44.724] Build status: STARTED
[01:12:44.724] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:109:0) after 8m35s
[01:21:19.753] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:109:0)
[01:21:19.782] Build status: STARTED
[01:21:19.782] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:110:0) after 3m7s
[01:24:26.815] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:110:0)
[01:24:26.838] Build status: STARTED
[01:24:26.838] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:111:0) after 2m12s
[01:26:39.261] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:111:0)
[01:26:39.289] Build status: STARTED
[01:26:39.289] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:112:0) after 1m41s
[01:28:20.488] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:112:0)
[01:28:20.508] Build status: STARTED
[01:28:20.508] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:113:0) after 7m52s
[01:36:12.909] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:113:0)
[01:36:12.937] Build status: STARTED
[01:36:12.937] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:114:0) after 9m43s
[01:45:56.240] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:114:0)
[01:45:56.269] Build status: STARTED
[01:45:56.269] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:115:0) after 1m8s
[01:47:04.841] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:115:0)
[01:47:04.883] Build status: STARTED
[01:47:04.883] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:116:0) after 1m37s
[01:48:42.047] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:116:0)
[01:48:42.073] Build status: STARTED
[01:48:42.073] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:117:0) after 1m27s
[01:50:09.097] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:117:0)
[01:50:09.131] Build status: STARTED
[01:50:09.131] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:118:0) after 5m37s
[01:55:46.181] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:118:0)
[01:55:46.203] Build status: STARTED
[01:55:46.203] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:119:0) after 7m44s
[02:03:30.327] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:119:0)
[02:03:30.360] Build status: STARTED
[02:03:30.360] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:120:0) after 3m58s
[02:07:28.561] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:120:0)
[02:07:28.595] Build status: STARTED
[02:07:28.595] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:121:0) after 2m58s
[02:10:26.625] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:121:0)
[02:10:26.648] Build status: STARTED
[02:10:26.648] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:122:0) after 7m24s
[02:17:50.785] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:122:0)
[02:17:50.805] Build status: STARTED
[02:17:50.805] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:123:0) after 6m39s
[02:24:29.887] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:123:0)
[02:24:29.914] Build status: STARTED
[02:24:29.914] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:124:0) after 8m24s
[02:32:54.042] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:124:0)
[02:32:54.067] Build status: STARTED
[02:32:54.067] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:125:0) after 5m21s
[02:38:15.236] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:125:0)
[02:38:15.332] Build status: STARTED
[02:38:15.332] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:126:0) after 8m9s
[02:46:24.360] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:126:0)
[02:46:24.464] Build status: STARTED
[02:46:24.464] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:127:0) after 7m8s
[02:53:32.574] Handling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:127:0)
[02:53:32.596] Build status: STARTED
[02:53:32.596] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin(dll):8985042174758405840:128:0) after 7m56s
[03:00:04.824] Received PubSub notification, asking Buildbucket for the build status
[03:00:04.889] Build:
{
"id": "8819612112796450353",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "ToTWin(dll)"
},
"number": 9929,
"createdBy": "project:chromium",
"createTime": "2022-03-15T15:51:09.568282067Z",
"startTime": "2022-03-15T17:20:29.013798Z",
"endTime": "2022-03-16T03:00:04.423607300Z",
"updateTime": "2022-03-16T03:00:04.423607300Z",
"status": "FAILURE",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "78198907c9adb1866b94d6d5f9b5f93ae01a6b96",
"ref": "refs/heads/main"
}
}
}
[03:00:04.889] Invocation finished in 11h8m56.576012048s with status FAILED