[12:57:46.479] New invocation is queued and will start shortly
[12:57:47.659] Starting the invocation (attempt 1)
[12:57:47.691] Popped buildset tag "buildset:commit/gitiles/r8.googlesource.com/r8/+/0e52f7d614672f837ec8c231a71d63b0b0d19ccd"
[12:57:47.691] Popped gitiles commit info from properties and tags
[12:57:47.691] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[12:57:47.691] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[12:57:47.691] Buildbucket request:
{
"requestId": "8951985189143107968",
"builder": {
"project": "r8",
"bucket": "ci",
"builder": "linux-internal_release"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8951985189143107968",
"job": "r8/linux-internal_release",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/8.0",
"repo": "https://r8.googlesource.com/r8",
"revision": "0e52f7d614672f837ec8c231a71d63b0b0d19ccd"
},
"id": "https://r8.googlesource.com/r8/+/refs/heads/8.0@0e52f7d614672f837ec8c231a71d63b0b0d19ccd",
"title": "0e52f7d614672f837ec8c231a71d63b0b0d19ccd",
"url": "https://r8.googlesource.com/r8/+/0e52f7d614672f837ec8c231a71d63b0b0d19ccd"
}
]
}
},
"gitilesCommit": {
"host": "r8.googlesource.com",
"project": "r8",
"id": "0e52f7d614672f837ec8c231a71d63b0b0d19ccd",
"ref": "refs/heads/8.0"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8951985189143107968"
},
{
"key": "scheduler_job_id",
"value": "r8/linux-internal_release"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[12:57:48.527] Scheduled build:
{
"id": "8786555127126430225",
"builder": {
"project": "r8",
"bucket": "ci",
"builder": "linux-internal_release"
},
"number": 839,
"createdBy": "project:r8",
"createTime": "2023-03-15T12:57:47.779580558Z",
"updateTime": "2023-03-15T12:57:47.779580558Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "r8.googlesource.com",
"project": "r8",
"id": "0e52f7d614672f837ec8c231a71d63b0b0d19ccd",
"ref": "refs/heads/8.0"
}
}
}
[12:57:48.527] Task URL: https://cr-buildbucket.appspot.com/build/8786555127126430225
[12:57:48.527] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:2:0) after 3m37s
[12:58:02.948] Received PubSub notification, asking Buildbucket for the build status
[12:58:02.986] Build status: STARTED
[13:01:25.588] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:2:0)
[13:01:25.634] Build status: STARTED
[13:01:25.635] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:4:0) after 2m20s
[13:03:45.794] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:4:0)
[13:03:45.839] Build status: STARTED
[13:03:45.839] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:5:0) after 3m6s
[13:06:51.965] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:5:0)
[13:06:52.032] Build status: STARTED
[13:06:52.032] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:6:0) after 5m13s
[13:12:05.163] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:6:0)
[13:12:05.236] Build status: STARTED
[13:12:05.236] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:7:0) after 3m40s
[13:15:45.351] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:7:0)
[13:15:45.375] Build status: STARTED
[13:15:45.375] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:8:0) after 3m2s
[13:18:47.399] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:8:0)
[13:18:47.466] Build status: STARTED
[13:18:47.466] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:9:0) after 7m11s
[13:25:58.518] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:9:0)
[13:25:58.630] Build status: STARTED
[13:25:58.630] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:10:0) after 8m46s
[13:34:44.736] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:10:0)
[13:34:44.791] Build status: STARTED
[13:34:44.791] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:11:0) after 7m48s
[13:42:32.817] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:11:0)
[13:42:32.867] Build status: STARTED
[13:42:32.867] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:12:0) after 6m36s
[13:49:08.927] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:12:0)
[13:49:09.007] Build status: STARTED
[13:49:09.008] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:13:0) after 6m0s
[13:55:09.267] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:13:0)
[13:55:09.301] Build status: STARTED
[13:55:09.301] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:14:0) after 6m12s
[14:01:21.327] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:14:0)
[14:01:21.355] Build status: STARTED
[14:01:21.355] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:15:0) after 9m32s
[14:10:53.392] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:15:0)
[14:10:53.431] Build status: STARTED
[14:10:53.431] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:16:0) after 3m34s
[14:14:27.534] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:16:0)
[14:14:27.555] Build status: STARTED
[14:14:27.555] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:17:0) after 4m47s
[14:19:14.562] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:17:0)
[14:19:14.584] Build status: STARTED
[14:19:14.584] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:18:0) after 9m56s
[14:29:10.760] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:18:0)
[14:29:10.807] Build status: STARTED
[14:29:10.807] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:19:0) after 6m54s
[14:36:04.885] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:19:0)
[14:36:04.926] Build status: STARTED
[14:36:04.926] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:20:0) after 2m3s
[14:38:08.106] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:20:0)
[14:38:08.134] Build status: STARTED
[14:38:08.134] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:21:0) after 9m28s
[14:47:37.167] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:21:0)
[14:47:37.187] Build status: STARTED
[14:47:37.187] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:22:0) after 1m59s
[14:49:36.214] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:22:0)
[14:49:36.308] Build status: STARTED
[14:49:36.308] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:23:0) after 9m12s
[14:58:48.439] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:23:0)
[14:58:48.463] Build status: STARTED
[14:58:48.463] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:24:0) after 5m58s
[15:04:46.452] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:24:0)
[15:04:46.488] Build status: STARTED
[15:04:46.488] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:25:0) after 8m55s
[15:13:41.508] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:25:0)
[15:13:41.529] Build status: STARTED
[15:13:41.529] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:26:0) after 5m37s
[15:19:18.496] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:26:0)
[15:19:18.528] Build status: STARTED
[15:19:18.528] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:27:0) after 9m15s
[15:28:33.545] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:27:0)
[15:28:33.566] Build status: STARTED
[15:28:33.566] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:28:0) after 3m5s
[15:31:38.595] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:28:0)
[15:31:38.620] Build status: STARTED
[15:31:38.620] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:29:0) after 2m2s
[15:33:40.846] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:29:0)
[15:33:40.883] Build status: STARTED
[15:33:40.883] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:30:0) after 1m42s
[15:35:23.190] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:30:0)
[15:35:23.212] Build status: STARTED
[15:35:23.212] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:31:0) after 3m22s
[15:38:45.231] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:31:0)
[15:38:45.259] Build status: STARTED
[15:38:45.259] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:32:0) after 7m47s
[15:46:32.484] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:32:0)
[15:46:32.507] Build status: STARTED
[15:46:32.507] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:33:0) after 2m10s
[15:48:42.996] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:33:0)
[15:48:43.018] Build status: STARTED
[15:48:43.018] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:34:0) after 2m55s
[15:51:38.029] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:34:0)
[15:51:38.061] Build status: STARTED
[15:51:38.061] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:35:0) after 4m57s
[15:56:35.127] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:35:0)
[15:56:35.147] Build status: STARTED
[15:56:35.147] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:36:0) after 6m31s
[16:03:06.697] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:36:0)
[16:03:06.720] Build status: STARTED
[16:03:06.720] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:37:0) after 5m23s
[16:08:29.796] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:37:0)
[16:08:29.832] Build status: STARTED
[16:08:29.832] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:38:0) after 4m7s
[16:12:36.863] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:38:0)
[16:12:36.896] Build status: STARTED
[16:12:36.896] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:39:0) after 9m1s
[16:21:38.028] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:39:0)
[16:21:38.076] Build status: STARTED
[16:21:38.076] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:40:0) after 4m32s
[16:26:10.096] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:40:0)
[16:26:10.130] Build status: STARTED
[16:26:10.130] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:41:0) after 4m35s
[16:30:45.190] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:41:0)
[16:30:45.229] Build status: STARTED
[16:30:45.229] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:42:0) after 6m34s
[16:37:19.259] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:42:0)
[16:37:19.308] Build status: STARTED
[16:37:19.308] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:43:0) after 7m7s
[16:44:26.563] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:43:0)
[16:44:26.584] Build status: STARTED
[16:44:26.584] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:44:0) after 8m11s
[16:52:37.741] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:44:0)
[16:52:37.764] Build status: STARTED
[16:52:37.764] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:45:0) after 3m32s
[16:56:10.112] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:45:0)
[16:56:10.148] Build status: STARTED
[16:56:10.148] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:46:0) after 9m1s
[17:05:11.568] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:46:0)
[17:05:11.600] Build status: STARTED
[17:05:11.600] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:47:0) after 5m21s
[17:10:32.635] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:47:0)
[17:10:32.675] Build status: STARTED
[17:10:32.675] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:48:0) after 5m49s
[17:16:21.698] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:48:0)
[17:16:21.720] Build status: STARTED
[17:16:21.720] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:49:0) after 7m1s
[17:23:22.745] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:49:0)
[17:23:22.768] Build status: STARTED
[17:23:22.768] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:50:0) after 4m3s
[17:27:25.890] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:50:0)
[17:27:25.917] Build status: STARTED
[17:27:25.917] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:51:0) after 3m13s
[17:30:39.009] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:51:0)
[17:30:39.033] Build status: STARTED
[17:30:39.033] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:52:0) after 3m45s
[17:34:24.363] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:52:0)
[17:34:24.392] Build status: STARTED
[17:34:24.392] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:53:0) after 8m35s
[17:42:59.422] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:53:0)
[17:42:59.448] Build status: STARTED
[17:42:59.448] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:54:0) after 3m17s
[17:46:16.496] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:54:0)
[17:46:16.594] Build status: STARTED
[17:46:16.594] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:55:0) after 8m59s
[17:55:15.628] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:55:0)
[17:55:15.651] Build status: STARTED
[17:55:15.651] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:56:0) after 8m39s
[18:03:54.682] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:56:0)
[18:03:54.720] Build status: STARTED
[18:03:54.720] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:57:0) after 3m49s
[18:07:44.334] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:57:0)
[18:07:44.372] Build status: STARTED
[18:07:44.372] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:58:0) after 1m0s
[18:08:44.494] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:58:0)
[18:08:44.647] Build status: STARTED
[18:08:44.647] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:59:0) after 4m33s
[18:13:17.687] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:59:0)
[18:13:17.711] Build status: STARTED
[18:13:17.711] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:60:0) after 2m44s
[18:16:01.968] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:60:0)
[18:16:01.991] Build status: STARTED
[18:16:01.991] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:61:0) after 6m54s
[18:22:56.263] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:61:0)
[18:22:56.306] Build status: STARTED
[18:22:56.306] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:62:0) after 3m16s
[18:26:12.609] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:62:0)
[18:26:12.690] Build status: STARTED
[18:26:12.690] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:63:0) after 9m29s
[18:35:41.771] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:63:0)
[18:35:41.842] Build status: STARTED
[18:35:41.842] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:64:0) after 9m0s
[18:44:42.328] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:64:0)
[18:44:42.359] Build status: STARTED
[18:44:42.359] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:65:0) after 5m56s
[18:50:38.424] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:65:0)
[18:50:38.461] Build status: STARTED
[18:50:38.461] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:66:0) after 1m4s
[18:51:42.958] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:66:0)
[18:51:43.004] Build status: STARTED
[18:51:43.004] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:67:0) after 5m45s
[18:57:28.053] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:67:0)
[18:57:28.098] Build status: STARTED
[18:57:28.098] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:68:0) after 2m44s
[19:00:12.137] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:68:0)
[19:00:12.185] Build status: STARTED
[19:00:12.185] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:69:0) after 7m22s
[19:07:34.212] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:69:0)
[19:07:34.243] Build status: STARTED
[19:07:34.244] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:70:0) after 2m29s
[19:10:03.708] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:70:0)
[19:10:03.749] Build status: STARTED
[19:10:03.749] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:71:0) after 6m56s
[19:16:59.969] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:71:0)
[19:17:00.049] Build status: STARTED
[19:17:00.049] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:72:0) after 7m34s
[19:24:34.083] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:72:0)
[19:24:34.105] Build status: STARTED
[19:24:34.105] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:73:0) after 2m22s
[19:26:56.126] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:73:0)
[19:26:56.148] Build status: STARTED
[19:26:56.148] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:74:0) after 6m3s
[19:32:59.466] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:74:0)
[19:32:59.503] Build status: STARTED
[19:32:59.503] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:75:0) after 5m48s
[19:38:47.547] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:75:0)
[19:38:47.571] Build status: STARTED
[19:38:47.571] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:76:0) after 3m30s
[19:42:17.632] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:76:0)
[19:42:17.651] Build status: STARTED
[19:42:17.651] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:77:0) after 6m38s
[19:48:55.737] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:77:0)
[19:48:55.770] Build status: STARTED
[19:48:55.770] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:78:0) after 6m17s
[19:55:12.844] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:78:0)
[19:55:12.868] Build status: STARTED
[19:55:12.868] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:79:0) after 4m10s
[19:59:23.308] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:79:0)
[19:59:23.338] Build status: STARTED
[19:59:23.338] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:80:0) after 6m2s
[20:05:25.805] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:80:0)
[20:05:25.839] Build status: STARTED
[20:05:25.839] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:81:0) after 3m42s
[20:09:07.902] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:81:0)
[20:09:07.925] Build status: STARTED
[20:09:07.925] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:82:0) after 2m58s
[20:12:06.327] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:82:0)
[20:12:06.351] Build status: STARTED
[20:12:06.351] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:83:0) after 2m4s
[20:14:10.548] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:83:0)
[20:14:10.620] Build status: STARTED
[20:14:10.620] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:84:0) after 1m5s
[20:15:15.699] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:84:0)
[20:15:15.719] Build status: STARTED
[20:15:15.719] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:85:0) after 9m20s
[20:24:35.810] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:85:0)
[20:24:35.845] Build status: STARTED
[20:24:35.845] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:86:0) after 4m5s
[20:28:40.866] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:86:0)
[20:28:40.910] Build status: STARTED
[20:28:40.910] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:87:0) after 5m29s
[20:34:10.065] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:87:0)
[20:34:10.097] Build status: STARTED
[20:34:10.097] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:88:0) after 1m47s
[20:35:57.080] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:88:0)
[20:35:57.110] Build status: STARTED
[20:35:57.110] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:89:0) after 6m11s
[20:42:08.131] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:89:0)
[20:42:08.158] Build status: STARTED
[20:42:08.158] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:90:0) after 2m22s
[20:44:30.180] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:90:0)
[20:44:30.235] Build status: STARTED
[20:44:30.235] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:91:0) after 1m24s
[20:45:54.401] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:91:0)
[20:45:54.435] Build status: STARTED
[20:45:54.435] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:92:0) after 9m49s
[20:55:43.546] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:92:0)
[20:55:43.581] Build status: STARTED
[20:55:43.581] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:93:0) after 8m14s
[21:03:57.920] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:93:0)
[21:03:58.113] Build status: STARTED
[21:03:58.113] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:94:0) after 1m59s
[21:05:57.358] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:94:0)
[21:05:57.391] Build status: STARTED
[21:05:57.391] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:95:0) after 5m44s
[21:11:41.467] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:95:0)
[21:11:41.516] Build status: STARTED
[21:11:41.516] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:96:0) after 3m13s
[21:14:54.646] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:96:0)
[21:14:54.689] Build status: STARTED
[21:14:54.689] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:97:0) after 6m42s
[21:21:36.724] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:97:0)
[21:21:36.754] Build status: STARTED
[21:21:36.754] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:98:0) after 1m5s
[21:22:41.775] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:98:0)
[21:22:41.808] Build status: STARTED
[21:22:41.808] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:99:0) after 8m55s
[21:31:37.477] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:99:0)
[21:31:37.514] Build status: STARTED
[21:31:37.514] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:100:0) after 8m20s
[21:39:57.536] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:100:0)
[21:39:57.576] Build status: STARTED
[21:39:57.576] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:101:0) after 2m37s
[21:42:34.839] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:101:0)
[21:42:34.870] Build status: STARTED
[21:42:34.870] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:102:0) after 8m10s
[21:50:45.105] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:102:0)
[21:50:45.124] Build status: STARTED
[21:50:45.124] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:103:0) after 5m47s
[21:56:32.639] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:103:0)
[21:56:32.670] Build status: STARTED
[21:56:32.670] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:104:0) after 7m21s
[22:03:53.842] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:104:0)
[22:03:53.895] Build status: STARTED
[22:03:53.895] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:105:0) after 3m9s
[22:07:03.038] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:105:0)
[22:07:03.098] Build status: STARTED
[22:07:03.098] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:106:0) after 5m11s
[22:12:14.120] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:106:0)
[22:12:14.221] Build status: STARTED
[22:12:14.221] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:107:0) after 5m19s
[22:17:33.366] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:107:0)
[22:17:33.398] Build status: STARTED
[22:17:33.398] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:108:0) after 4m11s
[22:21:44.622] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:108:0)
[22:21:44.742] Build status: STARTED
[22:21:44.742] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:109:0) after 9m59s
[22:31:43.762] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:109:0)
[22:31:43.793] Build status: STARTED
[22:31:43.793] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:110:0) after 8m1s
[22:39:44.952] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:110:0)
[22:39:44.984] Build status: STARTED
[22:39:44.984] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:111:0) after 5m13s
[22:44:58.057] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:111:0)
[22:44:58.088] Build status: STARTED
[22:44:58.088] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:112:0) after 2m21s
[22:47:19.347] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:112:0)
[22:47:19.379] Build status: STARTED
[22:47:19.379] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:113:0) after 4m30s
[22:51:49.423] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:113:0)
[22:51:49.445] Build status: STARTED
[22:51:49.445] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:114:0) after 8m42s
[23:00:31.562] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:114:0)
[23:00:31.602] Build status: STARTED
[23:00:31.602] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:115:0) after 2m50s
[23:03:21.628] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:115:0)
[23:03:21.669] Build status: STARTED
[23:03:21.669] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:116:0) after 7m27s
[23:10:48.690] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:116:0)
[23:10:48.797] Build status: STARTED
[23:10:48.797] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:117:0) after 3m32s
[23:14:21.084] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:117:0)
[23:14:21.147] Build status: STARTED
[23:14:21.148] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:118:0) after 4m0s
[23:18:21.167] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:118:0)
[23:18:21.208] Build status: STARTED
[23:18:21.208] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:119:0) after 1m33s
[23:19:54.201] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:119:0)
[23:19:54.244] Build status: STARTED
[23:19:54.244] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:120:0) after 4m22s
[23:24:16.386] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:120:0)
[23:24:16.406] Build status: STARTED
[23:24:16.406] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:121:0) after 7m52s
[23:32:08.526] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:121:0)
[23:32:08.552] Build status: STARTED
[23:32:08.552] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:122:0) after 7m0s
[23:39:08.646] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:122:0)
[23:39:08.678] Build status: STARTED
[23:39:08.679] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:123:0) after 8m18s
[23:47:27.054] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:123:0)
[23:47:27.079] Build status: STARTED
[23:47:27.079] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:124:0) after 1m46s
[23:49:13.128] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:124:0)
[23:49:13.163] Build status: STARTED
[23:49:13.163] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:125:0) after 3m31s
[23:52:44.258] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:125:0)
[23:52:44.285] Build status: STARTED
[23:52:44.285] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:126:0) after 5m30s
[23:58:14.653] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:126:0)
[23:58:14.723] Build status: STARTED
[23:58:14.723] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:127:0) after 5m0s
[00:03:14.743] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:127:0)
[00:03:14.778] Build status: STARTED
[00:03:14.778] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:128:0) after 6m32s
[00:09:46.798] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:128:0)
[00:09:46.836] Build status: STARTED
[00:09:46.836] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:129:0) after 9m43s
[00:19:29.854] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:129:0)
[00:19:29.895] Build status: STARTED
[00:19:29.895] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:130:0) after 4m41s
[00:24:11.023] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:130:0)
[00:24:11.056] Build status: STARTED
[00:24:11.057] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:131:0) after 2m49s
[00:27:00.209] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:131:0)
[00:27:00.245] Build status: STARTED
[00:27:00.245] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:132:0) after 7m3s
[00:34:03.339] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:132:0)
[00:34:03.377] Build status: STARTED
[00:34:03.377] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:133:0) after 3m32s
[00:37:35.439] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:133:0)
[00:37:35.459] Build status: STARTED
[00:37:35.459] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:134:0) after 3m20s
[00:40:55.572] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:134:0)
[00:40:55.601] Build status: STARTED
[00:40:55.601] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:135:0) after 2m23s
[00:43:19.120] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:135:0)
[00:43:19.152] Build status: STARTED
[00:43:19.152] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:136:0) after 8m54s
[00:52:13.333] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:136:0)
[00:52:13.364] Build status: STARTED
[00:52:13.364] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:137:0) after 2m45s
[00:54:58.918] Handling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:137:0)
[00:54:58.952] Build status: STARTED
[00:54:58.952] Scheduling timer "check-buildbucket-build-status" (r8/linux-internal_release:8951985189143107968:138:0) after 6m2s
[00:58:15.697] Received PubSub notification, asking Buildbucket for the build status
[00:58:15.725] Build:
{
"id": "8786555127126430225",
"builder": {
"project": "r8",
"bucket": "ci",
"builder": "linux-internal_release"
},
"number": 839,
"createdBy": "project:r8",
"createTime": "2023-03-15T12:57:47.779580558Z",
"startTime": "2023-03-15T12:58:02.428575Z",
"endTime": "2023-03-16T00:58:15.489141472Z",
"updateTime": "2023-03-16T00:58:15.489141472Z",
"status": "FAILURE",
"statusDetails": {
"timeout": {
}
},
"input": {
"gitilesCommit": {
"host": "r8.googlesource.com",
"project": "r8",
"id": "0e52f7d614672f837ec8c231a71d63b0b0d19ccd",
"ref": "refs/heads/8.0"
}
}
}
[00:58:15.725] Invocation finished in 12h0m29.251940794s with status FAILED