[05:18:58.736] New invocation is queued and will start shortly
[05:19:00.175] Starting the invocation (attempt 1)
[05:19:00.215] Popped buildset tag "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/7ef6cf2d0ebd5288fd8cd415b8d62ea9e04106f8"
[05:19:00.215] Popped gitiles commit info from properties and tags
[05:19:00.215] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[05:19:00.215] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[05:19:00.215] Buildbucket request:
{
"requestId": "8956272111499096816",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "ToTWin64"
},
"properties": {
},
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "7ef6cf2d0ebd5288fd8cd415b8d62ea9e04106f8",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8956272111499096816"
},
{
"key": "scheduler_job_id",
"value": "chromium/ToTWin64"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[05:19:00.688] Scheduled build:
{
"id": "8790842049212987985",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "ToTWin64"
},
"number": 3243,
"createdBy": "project:chromium",
"createTime": "2023-01-27T05:19:00.289701773Z",
"updateTime": "2023-01-27T05:19:00.289701773Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "7ef6cf2d0ebd5288fd8cd415b8d62ea9e04106f8",
"ref": "refs/heads/main"
}
}
}
[05:19:00.688] Task URL: https://cr-buildbucket.appspot.com/build/8790842049212987985
[05:19:00.688] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:2:0) after 2m47s
[05:19:12.253] Received PubSub notification, asking Buildbucket for the build status
[05:19:12.278] Build status: STARTED
[05:21:47.971] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:2:0)
[05:21:48.008] Build status: STARTED
[05:21:48.008] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:4:0) after 3m19s
[05:25:07.213] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:4:0)
[05:25:07.235] Build status: STARTED
[05:25:07.235] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:5:0) after 9m58s
[05:35:05.360] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:5:0)
[05:35:05.387] Build status: STARTED
[05:35:05.387] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:6:0) after 2m5s
[05:37:10.438] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:6:0)
[05:37:10.479] Build status: STARTED
[05:37:10.479] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:7:0) after 1m9s
[05:38:19.507] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:7:0)
[05:38:19.538] Build status: STARTED
[05:38:19.538] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:8:0) after 5m50s
[05:44:09.570] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:8:0)
[05:44:09.603] Build status: STARTED
[05:44:09.603] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:9:0) after 2m53s
[05:47:02.637] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:9:0)
[05:47:02.671] Build status: STARTED
[05:47:02.671] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:10:0) after 2m59s
[05:50:01.782] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:10:0)
[05:50:01.941] Build status: STARTED
[05:50:01.941] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:11:0) after 3m6s
[05:53:07.990] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:11:0)
[05:53:08.012] Build status: STARTED
[05:53:08.012] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:12:0) after 6m42s
[05:59:50.175] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:12:0)
[05:59:50.196] Build status: STARTED
[05:59:50.196] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:13:0) after 3m43s
[06:03:33.498] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:13:0)
[06:03:33.524] Build status: STARTED
[06:03:33.524] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:14:0) after 3m18s
[06:06:51.589] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:14:0)
[06:06:51.616] Build status: STARTED
[06:06:51.616] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:15:0) after 9m15s
[06:16:06.666] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:15:0)
[06:16:06.694] Build status: STARTED
[06:16:06.694] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:16:0) after 8m56s
[06:25:02.793] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:16:0)
[06:25:02.817] Build status: STARTED
[06:25:02.817] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:17:0) after 2m14s
[06:27:16.844] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:17:0)
[06:27:16.937] Build status: STARTED
[06:27:16.937] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:18:0) after 4m28s
[06:31:44.962] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:18:0)
[06:31:45.074] Build status: STARTED
[06:31:45.074] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:19:0) after 9m33s
[06:41:18.262] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:19:0)
[06:41:18.292] Build status: STARTED
[06:41:18.292] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:20:0) after 8m33s
[06:49:51.323] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:20:0)
[06:49:51.356] Build status: STARTED
[06:49:51.356] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:21:0) after 1m12s
[06:51:03.833] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:21:0)
[06:51:03.863] Build status: STARTED
[06:51:03.863] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:22:0) after 6m36s
[06:57:39.899] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:22:0)
[06:57:39.917] Build status: STARTED
[06:57:39.917] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:23:0) after 9m41s
[07:07:21.093] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:23:0)
[07:07:21.126] Build status: STARTED
[07:07:21.126] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:24:0) after 4m0s
[07:11:21.222] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:24:0)
[07:11:21.248] Build status: STARTED
[07:11:21.248] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:25:0) after 3m17s
[07:14:38.340] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:25:0)
[07:14:38.402] Build status: STARTED
[07:14:38.402] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:26:0) after 1m8s
[07:15:46.527] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:26:0)
[07:15:46.551] Build status: STARTED
[07:15:46.551] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:27:0) after 1m26s
[07:17:12.581] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:27:0)
[07:17:12.598] Build status: STARTED
[07:17:12.598] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:28:0) after 5m24s
[07:22:36.682] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:28:0)
[07:22:36.715] Build status: STARTED
[07:22:36.715] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:29:0) after 9m9s
[07:31:45.748] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:29:0)
[07:31:45.769] Build status: STARTED
[07:31:45.769] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:30:0) after 4m42s
[07:36:27.797] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:30:0)
[07:36:27.820] Build status: STARTED
[07:36:27.820] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:31:0) after 1m23s
[07:37:50.948] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:31:0)
[07:37:50.969] Build status: STARTED
[07:37:50.969] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:32:0) after 7m3s
[07:44:53.994] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:32:0)
[07:44:54.023] Build status: STARTED
[07:44:54.023] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:33:0) after 6m27s
[07:51:21.161] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:33:0)
[07:51:21.180] Build status: STARTED
[07:51:21.180] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:34:0) after 8m14s
[07:59:35.191] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:34:0)
[07:59:35.214] Build status: STARTED
[07:59:35.214] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:35:0) after 4m33s
[08:04:08.250] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:35:0)
[08:04:08.271] Build status: STARTED
[08:04:08.271] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:36:0) after 5m33s
[08:09:41.409] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:36:0)
[08:09:41.432] Build status: STARTED
[08:09:41.432] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:37:0) after 9m23s
[08:19:04.462] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:37:0)
[08:19:04.485] Build status: STARTED
[08:19:04.485] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:38:0) after 1m29s
[08:20:33.526] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:38:0)
[08:20:33.545] Build status: STARTED
[08:20:33.545] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:39:0) after 4m56s
[08:25:29.766] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:39:0)
[08:25:29.800] Build status: STARTED
[08:25:29.800] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:40:0) after 5m39s
[08:31:08.822] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:40:0)
[08:31:08.903] Build status: STARTED
[08:31:08.903] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:41:0) after 9m29s
[08:40:38.071] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:41:0)
[08:40:38.160] Build status: STARTED
[08:40:38.160] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:42:0) after 3m17s
[08:43:55.246] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:42:0)
[08:43:55.325] Build status: STARTED
[08:43:55.325] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:43:0) after 9m34s
[08:53:29.757] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:43:0)
[08:53:29.818] Build status: STARTED
[08:53:29.818] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:44:0) after 7m16s
[09:00:45.845] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:44:0)
[09:00:45.872] Build status: STARTED
[09:00:45.872] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:45:0) after 1m13s
[09:01:59.204] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:45:0)
[09:01:59.226] Build status: STARTED
[09:01:59.226] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:46:0) after 1m23s
[09:03:22.347] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:46:0)
[09:03:22.375] Build status: STARTED
[09:03:22.375] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:47:0) after 2m37s
[09:05:59.554] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:47:0)
[09:05:59.574] Build status: STARTED
[09:05:59.574] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:48:0) after 3m14s
[09:09:13.600] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:48:0)
[09:09:13.621] Build status: STARTED
[09:09:13.621] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:49:0) after 8m24s
[09:17:37.646] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:49:0)
[09:17:37.673] Build status: STARTED
[09:17:37.673] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:50:0) after 9m28s
[09:27:05.665] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:50:0)
[09:27:05.733] Build status: STARTED
[09:27:05.733] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:51:0) after 3m11s
[09:30:16.762] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:51:0)
[09:30:16.786] Build status: STARTED
[09:30:16.786] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:52:0) after 6m3s
[09:36:19.816] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:52:0)
[09:36:19.844] Build status: STARTED
[09:36:19.844] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:53:0) after 9m58s
[09:46:17.869] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:53:0)
[09:46:17.890] Build status: STARTED
[09:46:17.890] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:54:0) after 7m18s
[09:53:36.168] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:54:0)
[09:53:36.190] Build status: STARTED
[09:53:36.190] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:55:0) after 5m48s
[09:59:24.287] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:55:0)
[09:59:24.365] Build status: STARTED
[09:59:24.365] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:56:0) after 3m4s
[10:02:28.648] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:56:0)
[10:02:28.673] Build status: STARTED
[10:02:28.673] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:57:0) after 3m17s
[10:05:45.701] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:57:0)
[10:05:45.720] Build status: STARTED
[10:05:45.720] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:58:0) after 3m17s
[10:09:02.873] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:58:0)
[10:09:02.895] Build status: STARTED
[10:09:02.895] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:59:0) after 2m51s
[10:11:53.921] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:59:0)
[10:11:53.942] Build status: STARTED
[10:11:53.942] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:60:0) after 4m14s
[10:16:08.263] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:60:0)
[10:16:08.287] Build status: STARTED
[10:16:08.287] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:61:0) after 3m55s
[10:20:03.414] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:61:0)
[10:20:03.433] Build status: STARTED
[10:20:03.433] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:62:0) after 2m6s
[10:22:09.466] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:62:0)
[10:22:09.490] Build status: STARTED
[10:22:09.490] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:63:0) after 4m54s
[10:27:03.533] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:63:0)
[10:27:03.563] Build status: STARTED
[10:27:03.563] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:64:0) after 5m46s
[10:32:49.587] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:64:0)
[10:32:49.611] Build status: STARTED
[10:32:49.611] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:65:0) after 2m17s
[10:35:06.822] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:65:0)
[10:35:06.845] Build status: STARTED
[10:35:06.845] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:66:0) after 6m42s
[10:41:48.928] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:66:0)
[10:41:48.955] Build status: STARTED
[10:41:48.955] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:67:0) after 3m45s
[10:45:34.146] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:67:0)
[10:45:34.168] Build status: STARTED
[10:45:34.168] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:68:0) after 5m17s
[10:50:51.195] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:68:0)
[10:50:51.224] Build status: STARTED
[10:50:51.224] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:69:0) after 8m8s
[10:58:59.272] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:69:0)
[10:58:59.298] Build status: STARTED
[10:58:59.298] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:70:0) after 1m53s
[11:00:52.362] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:70:0)
[11:00:52.447] Build status: STARTED
[11:00:52.447] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:71:0) after 4m31s
[11:05:23.678] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:71:0)
[11:05:23.711] Build status: STARTED
[11:05:23.711] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:72:0) after 2m19s
[11:07:42.746] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:72:0)
[11:07:42.795] Build status: STARTED
[11:07:42.795] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:73:0) after 9m55s
[11:17:37.827] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:73:0)
[11:17:37.847] Build status: STARTED
[11:17:37.847] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:74:0) after 1m24s
[11:19:01.890] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:74:0)
[11:19:01.964] Build status: STARTED
[11:19:01.964] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:75:0) after 2m22s
[11:21:24.089] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:75:0)
[11:21:24.113] Build status: STARTED
[11:21:24.113] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:76:0) after 3m33s
[11:24:57.139] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:76:0)
[11:24:57.162] Build status: STARTED
[11:24:57.162] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:77:0) after 4m0s
[11:28:57.240] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:77:0)
[11:28:57.261] Build status: STARTED
[11:28:57.262] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:78:0) after 1m17s
[11:30:14.408] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:78:0)
[11:30:14.435] Build status: STARTED
[11:30:14.435] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:79:0) after 6m48s
[11:37:02.689] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:79:0)
[11:37:02.711] Build status: STARTED
[11:37:02.711] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:80:0) after 2m38s
[11:39:40.740] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:80:0)
[11:39:40.761] Build status: STARTED
[11:39:40.761] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:81:0) after 2m37s
[11:42:17.819] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:81:0)
[11:42:17.841] Build status: STARTED
[11:42:17.841] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:82:0) after 4m55s
[11:47:13.215] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:82:0)
[11:47:13.240] Build status: STARTED
[11:47:13.240] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:83:0) after 5m53s
[11:53:06.440] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:83:0)
[11:53:06.465] Build status: STARTED
[11:53:06.465] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:84:0) after 3m30s
[11:56:36.573] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:84:0)
[11:56:36.596] Build status: STARTED
[11:56:36.596] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:85:0) after 4m1s
[12:00:37.649] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:85:0)
[12:00:37.698] Build status: STARTED
[12:00:37.698] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:86:0) after 8m3s
[12:08:40.726] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:86:0)
[12:08:40.819] Build status: STARTED
[12:08:40.819] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:87:0) after 6m34s
[12:15:15.015] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:87:0)
[12:15:15.036] Build status: STARTED
[12:15:15.036] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:88:0) after 1m50s
[12:17:05.097] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:88:0)
[12:17:05.140] Build status: STARTED
[12:17:05.140] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:89:0) after 1m2s
[12:18:07.350] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:89:0)
[12:18:07.372] Build status: STARTED
[12:18:07.372] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:90:0) after 9m40s
[12:27:47.529] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:90:0)
[12:27:47.556] Build status: STARTED
[12:27:47.556] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:91:0) after 5m34s
[12:33:21.779] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:91:0)
[12:33:21.800] Build status: STARTED
[12:33:21.800] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:92:0) after 6m41s
[12:40:02.944] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:92:0)
[12:40:03.022] Build status: STARTED
[12:40:03.022] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:93:0) after 5m41s
[12:45:44.155] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:93:0)
[12:45:44.179] Build status: STARTED
[12:45:44.179] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:94:0) after 5m44s
[12:51:28.804] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:94:0)
[12:51:28.829] Build status: STARTED
[12:51:28.829] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:95:0) after 7m46s
[12:59:14.940] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:95:0)
[12:59:14.962] Build status: STARTED
[12:59:14.962] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:96:0) after 2m3s
[13:01:17.988] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:96:0)
[13:01:18.020] Build status: STARTED
[13:01:18.020] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:97:0) after 7m23s
[13:08:41.267] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:97:0)
[13:08:41.286] Build status: STARTED
[13:08:41.286] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:98:0) after 6m43s
[13:15:24.459] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:98:0)
[13:15:24.479] Build status: STARTED
[13:15:24.479] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:99:0) after 8m26s
[13:23:50.523] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:99:0)
[13:23:50.549] Build status: STARTED
[13:23:50.549] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:100:0) after 4m30s
[13:28:20.586] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:100:0)
[13:28:20.608] Build status: STARTED
[13:28:20.608] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:101:0) after 6m28s
[13:34:48.644] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:101:0)
[13:34:48.671] Build status: STARTED
[13:34:48.671] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:102:0) after 3m1s
[13:37:50.249] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:102:0)
[13:37:50.273] Build status: STARTED
[13:37:50.273] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:103:0) after 7m1s
[13:44:51.386] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:103:0)
[13:44:51.408] Build status: STARTED
[13:44:51.408] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:104:0) after 7m44s
[13:52:35.674] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:104:0)
[13:52:35.698] Build status: STARTED
[13:52:35.699] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:105:0) after 4m21s
[13:56:56.687] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:105:0)
[13:56:56.762] Build status: STARTED
[13:56:56.762] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:106:0) after 2m20s
[13:59:16.850] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:106:0)
[13:59:16.877] Build status: STARTED
[13:59:16.878] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:107:0) after 9m25s
[14:08:41.918] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:107:0)
[14:08:41.942] Build status: STARTED
[14:08:41.942] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:108:0) after 7m12s
[14:15:54.253] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:108:0)
[14:15:54.295] Build status: STARTED
[14:15:54.295] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:109:0) after 8m7s
[14:24:01.370] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:109:0)
[14:24:01.401] Build status: STARTED
[14:24:01.401] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:110:0) after 9m49s
[14:33:50.554] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:110:0)
[14:33:50.599] Build status: STARTED
[14:33:50.599] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:111:0) after 9m50s
[14:43:40.718] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:111:0)
[14:43:40.741] Build status: STARTED
[14:43:40.741] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:112:0) after 4m25s
[14:48:05.826] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:112:0)
[14:48:05.850] Build status: STARTED
[14:48:05.850] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:113:0) after 9m51s
[14:57:56.978] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:113:0)
[14:57:57.004] Build status: STARTED
[14:57:57.004] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:114:0) after 5m6s
[15:03:03.323] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:114:0)
[15:03:03.346] Build status: STARTED
[15:03:03.346] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:115:0) after 8m20s
[15:11:23.580] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:115:0)
[15:11:23.604] Build status: STARTED
[15:11:23.604] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:116:0) after 9m47s
[15:21:10.693] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:116:0)
[15:21:10.768] Build status: STARTED
[15:21:10.768] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:117:0) after 3m5s
[15:24:15.805] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:117:0)
[15:24:15.825] Build status: STARTED
[15:24:15.825] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:118:0) after 3m29s
[15:27:44.863] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:118:0)
[15:27:44.915] Build status: STARTED
[15:27:44.916] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:119:0) after 7m44s
[15:35:28.951] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:119:0)
[15:35:29.000] Build status: STARTED
[15:35:29.000] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:120:0) after 6m6s
[15:41:35.041] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:120:0)
[15:41:35.072] Build status: STARTED
[15:41:35.072] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:121:0) after 2m31s
[15:44:06.097] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:121:0)
[15:44:06.147] Build status: STARTED
[15:44:06.147] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:122:0) after 4m29s
[15:48:35.187] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:122:0)
[15:48:35.211] Build status: STARTED
[15:48:35.211] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:123:0) after 2m18s
[15:50:53.347] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:123:0)
[15:50:53.374] Build status: STARTED
[15:50:53.374] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8956272111499096816:124:0) after 1m42s
[15:52:30.228] Received PubSub notification, asking Buildbucket for the build status
[15:52:30.248] Build:
{
"id": "8790842049212987985",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "ToTWin64"
},
"number": 3243,
"createdBy": "project:chromium",
"createTime": "2023-01-27T05:19:00.289701773Z",
"startTime": "2023-01-27T05:19:09.199987Z",
"endTime": "2023-01-27T15:52:29.453868475Z",
"updateTime": "2023-01-27T15:52:29.453868475Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "7ef6cf2d0ebd5288fd8cd415b8d62ea9e04106f8",
"ref": "refs/heads/main"
}
}
}
[15:52:30.249] Invocation finished in 10h33m31.5238851s with status SUCCEEDED