[15:42:59.411] New invocation is queued and will start shortly
[15:43:01.047] Starting the invocation (attempt 1)
[15:43:01.079] Popped buildset tag "buildset:commit/gitiles/r8.googlesource.com/r8/+/7d21f1775699ead07581977bfc6aeeeb10360a7a"
[15:43:01.079] Popped gitiles commit info from properties and tags
[15:43:01.079] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[15:43:01.080] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[15:43:01.080] Buildbucket request:
{
"requestId": "8989481938786035856",
"builder": {
"project": "r8",
"bucket": "ci",
"builder": "linux-run-on-app-dump_release"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/3.3",
"repo": "https://r8.googlesource.com/r8",
"revision": "7d21f1775699ead07581977bfc6aeeeb10360a7a"
},
"id": "https://r8.googlesource.com/r8/+/refs/heads/3.3@7d21f1775699ead07581977bfc6aeeeb10360a7a",
"title": "7d21f1775699ead07581977bfc6aeeeb10360a7a",
"url": "https://r8.googlesource.com/r8/+/7d21f1775699ead07581977bfc6aeeeb10360a7a"
}
]
}
},
"gitilesCommit": {
"host": "r8.googlesource.com",
"project": "r8",
"id": "7d21f1775699ead07581977bfc6aeeeb10360a7a",
"ref": "refs/heads/3.3"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8989481938786035856"
},
{
"key": "scheduler_job_id",
"value": "r8/linux-run-on-app-dump_release"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[15:43:01.627] Scheduled build:
{
"id": "8824051876298499185",
"builder": {
"project": "r8",
"bucket": "ci",
"builder": "linux-run-on-app-dump_release"
},
"number": 211,
"createdBy": "project:r8",
"createTime": "2022-01-25T15:43:01.145622220Z",
"updateTime": "2022-01-25T15:43:01.145622220Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "r8.googlesource.com",
"project": "r8",
"id": "7d21f1775699ead07581977bfc6aeeeb10360a7a",
"ref": "refs/heads/3.3"
}
},
"canary": true
}
[15:43:01.627] Task URL: https://cr-buildbucket.appspot.com/build/8824051876298499185
[15:43:01.627] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:2:0) after 4m51s
[15:47:52.971] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:2:0)
[15:47:52.991] Build status: SCHEDULED
[15:47:52.991] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:3:0) after 2m31s
[15:50:24.012] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:3:0)
[15:50:24.031] Build status: SCHEDULED
[15:50:24.031] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:4:0) after 2m12s
[15:52:36.045] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:4:0)
[15:52:36.074] Build status: SCHEDULED
[15:52:36.074] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:5:0) after 4m30s
[15:57:06.092] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:5:0)
[15:57:06.125] Build status: SCHEDULED
[15:57:06.125] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:6:0) after 2m24s
[15:59:30.138] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:6:0)
[15:59:30.158] Build status: SCHEDULED
[15:59:30.158] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:7:0) after 8m18s
[16:07:48.470] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:7:0)
[16:07:48.498] Build status: SCHEDULED
[16:07:48.498] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:8:0) after 7m55s
[16:15:43.690] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:8:0)
[16:15:43.714] Build status: SCHEDULED
[16:15:43.714] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:9:0) after 3m38s
[16:19:21.963] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:9:0)
[16:19:22.002] Build status: SCHEDULED
[16:19:22.002] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:10:0) after 4m20s
[16:23:42.055] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:10:0)
[16:23:42.182] Build status: SCHEDULED
[16:23:42.182] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:11:0) after 3m49s
[16:27:31.357] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:11:0)
[16:27:31.396] Build status: SCHEDULED
[16:27:31.396] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:12:0) after 3m21s
[16:30:52.421] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:12:0)
[16:30:52.451] Build status: SCHEDULED
[16:30:52.451] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:13:0) after 1m29s
[16:32:21.437] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:13:0)
[16:32:21.458] Build status: SCHEDULED
[16:32:21.458] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:14:0) after 6m40s
[16:39:01.677] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:14:0)
[16:39:01.740] Build status: SCHEDULED
[16:39:01.740] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:15:0) after 5m4s
[16:44:05.746] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:15:0)
[16:44:05.769] Build status: SCHEDULED
[16:44:05.769] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:16:0) after 4m53s
[16:48:58.791] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:16:0)
[16:48:58.822] Build status: SCHEDULED
[16:48:58.822] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:17:0) after 7m44s
[16:56:43.057] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:17:0)
[16:56:43.084] Build status: SCHEDULED
[16:56:43.084] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:18:0) after 3m51s
[17:00:34.116] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:18:0)
[17:00:34.142] Build status: SCHEDULED
[17:00:34.142] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:19:0) after 1m8s
[17:01:42.191] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:19:0)
[17:01:42.222] Build status: SCHEDULED
[17:01:42.222] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:20:0) after 5m12s
[17:06:54.415] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:20:0)
[17:06:54.450] Build status: SCHEDULED
[17:06:54.450] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:21:0) after 9m52s
[17:16:46.499] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:21:0)
[17:16:46.531] Build status: SCHEDULED
[17:16:46.531] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:22:0) after 4m23s
[17:21:09.612] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:22:0)
[17:21:09.719] Build status: SCHEDULED
[17:21:09.719] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:23:0) after 9m2s
[17:30:11.904] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:23:0)
[17:30:11.937] Build status: SCHEDULED
[17:30:11.937] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:24:0) after 9m28s
[17:39:39.983] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:24:0)
[17:39:40.005] Build status: SCHEDULED
[17:39:40.006] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:25:0) after 4m27s
[17:44:07.023] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:25:0)
[17:44:07.058] Build status: SCHEDULED
[17:44:07.058] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:26:0) after 1m42s
[17:45:49.078] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:26:0)
[17:45:49.113] Build status: SCHEDULED
[17:45:49.113] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:27:0) after 7m37s
[17:53:26.924] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:27:0)
[17:53:27.016] Build status: SCHEDULED
[17:53:27.016] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:28:0) after 5m2s
[17:58:29.547] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:28:0)
[17:58:29.639] Build status: SCHEDULED
[17:58:29.639] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:29:0) after 4m30s
[18:03:00.814] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:29:0)
[18:03:00.843] Build status: SCHEDULED
[18:03:00.843] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:30:0) after 2m26s
[18:05:26.861] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:30:0)
[18:05:26.896] Build status: SCHEDULED
[18:05:26.896] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:31:0) after 5m13s
[18:10:39.881] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:31:0)
[18:10:39.910] Build status: SCHEDULED
[18:10:39.910] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:32:0) after 7m9s
[18:17:48.983] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:32:0)
[18:17:49.017] Build status: SCHEDULED
[18:17:49.017] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:33:0) after 8m7s
[18:25:56.050] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:33:0)
[18:25:56.132] Build status: SCHEDULED
[18:25:56.132] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:34:0) after 2m54s
[18:28:50.150] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:34:0)
[18:28:50.179] Build status: SCHEDULED
[18:28:50.179] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:35:0) after 3m55s
[18:32:45.201] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:35:0)
[18:32:45.222] Build status: SCHEDULED
[18:32:45.222] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:36:0) after 4m43s
[18:37:28.239] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:36:0)
[18:37:28.275] Build status: SCHEDULED
[18:37:28.275] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:37:0) after 3m35s
[18:41:03.292] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:37:0)
[18:41:03.326] Build status: SCHEDULED
[18:41:03.326] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:38:0) after 5m31s
[18:46:34.367] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:38:0)
[18:46:34.397] Build status: SCHEDULED
[18:46:34.397] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:39:0) after 6m36s
[18:53:10.438] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:39:0)
[18:53:10.471] Build status: SCHEDULED
[18:53:10.471] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:40:0) after 6m28s
[18:59:38.516] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:40:0)
[18:59:38.652] Build status: SCHEDULED
[18:59:38.652] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:41:0) after 4m47s
[19:04:25.770] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:41:0)
[19:04:25.847] Build status: SCHEDULED
[19:04:25.847] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:42:0) after 1m20s
[19:05:45.936] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:42:0)
[19:05:45.974] Build status: SCHEDULED
[19:05:45.974] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:43:0) after 6m19s
[19:12:05.545] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:43:0)
[19:12:05.575] Build status: SCHEDULED
[19:12:05.575] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:44:0) after 5m13s
[19:17:18.593] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:44:0)
[19:17:18.624] Build status: SCHEDULED
[19:17:18.624] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:45:0) after 9m2s
[19:26:20.644] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:45:0)
[19:26:20.674] Build status: SCHEDULED
[19:26:20.674] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:46:0) after 1m34s
[19:27:54.831] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:46:0)
[19:27:54.855] Build status: SCHEDULED
[19:27:54.855] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:47:0) after 7m14s
[19:35:08.875] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:47:0)
[19:35:08.896] Build status: SCHEDULED
[19:35:08.896] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:48:0) after 1m15s
[19:36:23.880] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:48:0)
[19:36:23.909] Build status: SCHEDULED
[19:36:23.909] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:49:0) after 2m10s
[19:38:34.272] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:49:0)
[19:38:34.324] Build status: SCHEDULED
[19:38:34.324] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:50:0) after 1m17s
[19:39:51.345] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:50:0)
[19:39:51.377] Build status: SCHEDULED
[19:39:51.377] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:51:0) after 2m3s
[19:41:54.777] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:51:0)
[19:41:54.839] Build status: SCHEDULED
[19:41:54.839] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:52:0) after 3m23s
[19:45:17.877] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:52:0)
[19:45:17.916] Build status: SCHEDULED
[19:45:17.917] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:53:0) after 8m28s
[19:53:45.940] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:53:0)
[19:53:45.973] Build status: SCHEDULED
[19:53:45.973] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:54:0) after 2m30s
[19:56:16.002] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:54:0)
[19:56:16.069] Build status: SCHEDULED
[19:56:16.069] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:55:0) after 5m26s
[20:01:42.092] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:55:0)
[20:01:42.155] Build status: SCHEDULED
[20:01:42.155] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:56:0) after 3m44s
[20:05:26.248] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:56:0)
[20:05:26.362] Build status: SCHEDULED
[20:05:26.362] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:57:0) after 5m0s
[20:10:26.539] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:57:0)
[20:10:26.592] Build status: SCHEDULED
[20:10:26.592] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:58:0) after 1m49s
[20:12:15.612] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:58:0)
[20:12:15.661] Build status: SCHEDULED
[20:12:15.661] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:59:0) after 4m31s
[20:16:46.680] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:59:0)
[20:16:46.717] Build status: SCHEDULED
[20:16:46.717] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:60:0) after 2m5s
[20:18:51.739] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:60:0)
[20:18:51.768] Build status: SCHEDULED
[20:18:51.768] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:61:0) after 5m1s
[20:23:52.788] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:61:0)
[20:23:52.827] Build status: SCHEDULED
[20:23:52.827] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:62:0) after 3m40s
[20:27:32.874] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:62:0)
[20:27:32.967] Build status: SCHEDULED
[20:27:32.967] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:63:0) after 5m57s
[20:33:29.995] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:63:0)
[20:33:30.026] Build status: SCHEDULED
[20:33:30.026] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:64:0) after 5m48s
[20:39:18.570] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:64:0)
[20:39:18.599] Build status: SCHEDULED
[20:39:18.599] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:65:0) after 4m3s
[20:43:21.620] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:65:0)
[20:43:21.650] Build status: SCHEDULED
[20:43:21.650] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:66:0) after 9m25s
[20:52:46.668] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:66:0)
[20:52:46.695] Build status: SCHEDULED
[20:52:46.695] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:67:0) after 4m59s
[20:57:45.812] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:67:0)
[20:57:45.844] Build status: SCHEDULED
[20:57:45.844] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:68:0) after 3m28s
[21:01:13.841] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:68:0)
[21:01:13.955] Build status: SCHEDULED
[21:01:13.955] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:69:0) after 2m10s
[21:03:23.974] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:69:0)
[21:03:23.995] Build status: SCHEDULED
[21:03:23.995] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:70:0) after 8m44s
[21:12:08.072] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:70:0)
[21:12:08.168] Build status: SCHEDULED
[21:12:08.168] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:71:0) after 3m51s
[21:15:59.205] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:71:0)
[21:15:59.251] Build status: SCHEDULED
[21:15:59.251] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:72:0) after 6m15s
[21:22:14.670] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:72:0)
[21:22:14.900] Build status: SCHEDULED
[21:22:14.900] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:73:0) after 5m29s
[21:27:43.920] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:73:0)
[21:27:43.949] Build status: SCHEDULED
[21:27:43.949] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:74:0) after 4m54s
[21:32:38.278] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:74:0)
[21:32:38.301] Build status: SCHEDULED
[21:32:38.301] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:75:0) after 7m50s
[21:40:28.348] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:75:0)
[21:40:28.446] Build status: SCHEDULED
[21:40:28.446] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:76:0) after 4m21s
[21:44:49.469] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:76:0)
[21:44:49.761] Build status: SCHEDULED
[21:44:49.761] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:77:0) after 1m30s
[21:46:19.780] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:77:0)
[21:46:19.820] Build status: SCHEDULED
[21:46:19.820] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:78:0) after 6m48s
[21:53:08.011] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:78:0)
[21:53:08.074] Build status: SCHEDULED
[21:53:08.074] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:79:0) after 4m38s
[21:57:46.727] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:79:0)
[21:57:46.756] Build status: SCHEDULED
[21:57:46.756] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:80:0) after 6m57s
[22:04:43.774] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:80:0)
[22:04:43.874] Build status: SCHEDULED
[22:04:43.874] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:81:0) after 4m51s
[22:09:34.944] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:81:0)
[22:09:35.277] Build status: SCHEDULED
[22:09:35.277] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:82:0) after 2m36s
[22:12:11.337] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:82:0)
[22:12:11.359] Build status: SCHEDULED
[22:12:11.359] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:83:0) after 9m6s
[22:21:17.484] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:83:0)
[22:21:17.522] Build status: SCHEDULED
[22:21:17.522] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:84:0) after 6m8s
[22:27:25.513] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:84:0)
[22:27:25.574] Build status: SCHEDULED
[22:27:25.575] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:85:0) after 8m35s
[22:36:00.627] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:85:0)
[22:36:00.657] Build status: SCHEDULED
[22:36:00.657] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:86:0) after 5m15s
[22:41:16.000] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:86:0)
[22:41:16.055] Build status: SCHEDULED
[22:41:16.055] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:87:0) after 6m21s
[22:47:37.083] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:87:0)
[22:47:37.122] Build status: SCHEDULED
[22:47:37.122] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:88:0) after 5m17s
[22:52:54.736] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:88:0)
[22:52:54.769] Build status: SCHEDULED
[22:52:54.769] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:89:0) after 2m40s
[22:55:34.809] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:89:0)
[22:55:34.835] Build status: SCHEDULED
[22:55:34.835] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:90:0) after 7m17s
[23:02:52.013] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:90:0)
[23:02:52.065] Build status: SCHEDULED
[23:02:52.065] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:91:0) after 1m10s
[23:04:02.087] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:91:0)
[23:04:02.184] Build status: SCHEDULED
[23:04:02.184] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:92:0) after 3m17s
[23:07:19.186] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:92:0)
[23:07:19.240] Build status: SCHEDULED
[23:07:19.240] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:93:0) after 9m36s
[23:16:55.395] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:93:0)
[23:16:55.420] Build status: SCHEDULED
[23:16:55.420] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:94:0) after 2m16s
[23:19:11.564] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:94:0)
[23:19:11.587] Build status: SCHEDULED
[23:19:11.587] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:95:0) after 4m35s
[23:23:46.710] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:95:0)
[23:23:46.737] Build status: SCHEDULED
[23:23:46.737] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:96:0) after 1m29s
[23:25:15.812] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:96:0)
[23:25:15.832] Build status: SCHEDULED
[23:25:15.832] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:97:0) after 1m13s
[23:26:29.037] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:97:0)
[23:26:29.061] Build status: SCHEDULED
[23:26:29.061] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:98:0) after 9m31s
[23:36:00.140] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:98:0)
[23:36:00.169] Build status: SCHEDULED
[23:36:00.169] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:99:0) after 5m47s
[23:41:47.340] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:99:0)
[23:41:47.497] Build status: SCHEDULED
[23:41:47.497] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:100:0) after 2m12s
[23:43:59.610] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:100:0)
[23:43:59.628] Build status: SCHEDULED
[23:43:59.628] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:101:0) after 5m4s
[23:49:03.973] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:101:0)
[23:49:03.990] Build status: SCHEDULED
[23:49:03.991] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:102:0) after 1m31s
[23:50:35.012] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:102:0)
[23:50:35.034] Build status: SCHEDULED
[23:50:35.034] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:103:0) after 4m17s
[23:54:52.088] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:103:0)
[23:54:52.110] Build status: SCHEDULED
[23:54:52.110] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:104:0) after 4m19s
[23:59:11.105] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:104:0)
[23:59:11.287] Build status: SCHEDULED
[23:59:11.287] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:105:0) after 6m14s
[00:05:25.541] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:105:0)
[00:05:25.579] Build status: SCHEDULED
[00:05:25.579] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:106:0) after 6m13s
[00:11:38.726] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:106:0)
[00:11:38.757] Build status: SCHEDULED
[00:11:38.758] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:107:0) after 3m23s
[00:15:01.864] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:107:0)
[00:15:01.888] Build status: SCHEDULED
[00:15:01.888] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:108:0) after 6m57s
[00:21:59.012] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:108:0)
[00:21:59.041] Build status: SCHEDULED
[00:21:59.041] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:109:0) after 6m3s
[00:28:02.114] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:109:0)
[00:28:02.135] Build status: SCHEDULED
[00:28:02.135] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:110:0) after 4m44s
[00:32:46.402] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:110:0)
[00:32:46.429] Build status: SCHEDULED
[00:32:46.429] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:111:0) after 4m8s
[00:36:54.556] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:111:0)
[00:36:54.600] Build status: SCHEDULED
[00:36:54.600] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:112:0) after 7m59s
[00:44:53.696] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:112:0)
[00:44:53.766] Build status: SCHEDULED
[00:44:53.766] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:113:0) after 5m49s
[00:50:42.902] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:113:0)
[00:50:42.931] Build status: SCHEDULED
[00:50:42.931] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:114:0) after 4m14s
[00:54:56.953] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:114:0)
[00:54:56.988] Build status: SCHEDULED
[00:54:56.988] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:115:0) after 7m56s
[01:02:53.110] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:115:0)
[01:02:53.134] Build status: SCHEDULED
[01:02:53.134] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:116:0) after 2m44s
[01:05:37.172] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:116:0)
[01:05:37.244] Build status: SCHEDULED
[01:05:37.244] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:117:0) after 9m2s
[01:14:39.510] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:117:0)
[01:14:39.548] Build status: SCHEDULED
[01:14:39.548] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:118:0) after 4m59s
[01:19:38.575] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:118:0)
[01:19:38.602] Build status: SCHEDULED
[01:19:38.602] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:119:0) after 4m3s
[01:23:41.623] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:119:0)
[01:23:41.660] Build status: SCHEDULED
[01:23:41.660] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:120:0) after 9m24s
[01:33:05.858] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:120:0)
[01:33:05.890] Build status: SCHEDULED
[01:33:05.890] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:121:0) after 4m43s
[01:37:48.956] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:121:0)
[01:37:48.984] Build status: SCHEDULED
[01:37:48.984] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:122:0) after 8m47s
[01:43:03.414] Received PubSub notification, asking Buildbucket for the build status
[01:43:03.442] Build status: STARTED
[01:46:36.005] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:122:0)
[01:46:36.095] Build status: STARTED
[01:46:36.095] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:124:0) after 6m43s
[01:53:19.268] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:124:0)
[01:53:19.298] Build status: STARTED
[01:53:19.298] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:125:0) after 5m13s
[01:58:32.532] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:125:0)
[01:58:32.563] Build status: STARTED
[01:58:32.563] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:126:0) after 5m57s
[02:04:29.577] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:126:0)
[02:04:29.605] Build status: STARTED
[02:04:29.605] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:127:0) after 9m16s
[02:13:45.633] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:127:0)
[02:13:45.667] Build status: STARTED
[02:13:45.667] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:128:0) after 5m53s
[02:19:39.460] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:128:0)
[02:19:39.495] Build status: STARTED
[02:19:39.495] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:129:0) after 4m52s
[02:24:31.985] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:129:0)
[02:24:32.005] Build status: STARTED
[02:24:32.005] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:130:0) after 4m1s
[02:28:33.029] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:130:0)
[02:28:33.059] Build status: STARTED
[02:28:33.059] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:131:0) after 4m38s
[02:33:11.362] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:131:0)
[02:33:11.394] Build status: STARTED
[02:33:11.394] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:132:0) after 2m50s
[02:36:01.480] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:132:0)
[02:36:01.545] Build status: STARTED
[02:36:01.545] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:133:0) after 4m48s
[02:40:49.566] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:133:0)
[02:40:49.598] Build status: STARTED
[02:40:49.598] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:134:0) after 7m17s
[02:48:07.357] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:134:0)
[02:48:07.392] Build status: STARTED
[02:48:07.392] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:135:0) after 2m0s
[02:50:07.417] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:135:0)
[02:50:07.442] Build status: STARTED
[02:50:07.442] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:136:0) after 4m56s
[02:55:03.924] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:136:0)
[02:55:03.960] Build status: STARTED
[02:55:03.960] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:137:0) after 2m15s
[02:57:18.966] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:137:0)
[02:57:18.991] Build status: STARTED
[02:57:18.991] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:138:0) after 5m44s
[03:03:03.011] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:138:0)
[03:03:03.039] Build status: STARTED
[03:03:03.039] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:139:0) after 9m35s
[03:12:38.224] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:139:0)
[03:12:38.245] Build status: STARTED
[03:12:38.245] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:140:0) after 9m33s
[03:22:11.351] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:140:0)
[03:22:11.378] Build status: STARTED
[03:22:11.378] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:141:0) after 2m33s
[03:24:44.501] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:141:0)
[03:24:44.535] Build status: STARTED
[03:24:44.535] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:142:0) after 7m27s
[03:32:11.782] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:142:0)
[03:32:11.839] Build status: STARTED
[03:32:11.839] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:143:0) after 9m56s
[03:42:07.988] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:143:0)
[03:42:08.009] Build status: STARTED
[03:42:08.009] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:144:0) after 2m3s
[03:44:11.029] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:144:0)
[03:44:11.084] Build status: STARTED
[03:44:11.084] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:145:0) after 8m24s
[03:52:35.690] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:145:0)
[03:52:35.724] Build status: STARTED
[03:52:35.724] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:146:0) after 9m57s
[04:02:32.756] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:146:0)
[04:02:32.784] Build status: STARTED
[04:02:32.784] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:147:0) after 9m2s
[04:11:34.923] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:147:0)
[04:11:34.958] Build status: STARTED
[04:11:34.958] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:148:0) after 9m40s
[04:21:14.980] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:148:0)
[04:21:15.042] Build status: STARTED
[04:21:15.042] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:149:0) after 5m8s
[04:26:23.113] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:149:0)
[04:26:23.145] Build status: STARTED
[04:26:23.145] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:150:0) after 7m2s
[04:33:25.292] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:150:0)
[04:33:25.349] Build status: STARTED
[04:33:25.349] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:151:0) after 7m54s
[04:41:19.329] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:151:0)
[04:41:19.358] Build status: STARTED
[04:41:19.358] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:152:0) after 8m19s
[04:49:38.624] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:152:0)
[04:49:38.656] Build status: STARTED
[04:49:38.656] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:153:0) after 1m55s
[04:51:33.758] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:153:0)
[04:51:33.792] Build status: STARTED
[04:51:33.792] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:154:0) after 3m40s
[04:55:13.819] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:154:0)
[04:55:13.889] Build status: STARTED
[04:55:13.889] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:155:0) after 8m52s
[05:04:06.020] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:155:0)
[05:04:06.056] Build status: STARTED
[05:04:06.056] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:156:0) after 1m22s
[05:05:28.088] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:156:0)
[05:05:28.195] Build status: STARTED
[05:05:28.195] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:157:0) after 7m58s
[05:13:26.312] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:157:0)
[05:13:26.347] Build status: STARTED
[05:13:26.347] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:158:0) after 4m23s
[05:17:49.371] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:158:0)
[05:17:49.760] Build status: STARTED
[05:17:49.760] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:159:0) after 4m39s
[05:22:28.895] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:159:0)
[05:22:28.918] Build status: STARTED
[05:22:28.918] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:160:0) after 3m35s
[05:26:03.941] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:160:0)
[05:26:03.966] Build status: STARTED
[05:26:03.966] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:161:0) after 2m5s
[05:28:08.991] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:161:0)
[05:28:09.010] Build status: STARTED
[05:28:09.010] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:162:0) after 5m57s
[05:34:06.135] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:162:0)
[05:34:06.185] Build status: STARTED
[05:34:06.185] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:163:0) after 4m58s
[05:39:04.223] Handling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:163:0)
[05:39:04.259] Build status: STARTED
[05:39:04.259] Scheduling timer "check-buildbucket-build-status" (r8/linux-run-on-app-dump_release:8989481938786035856:164:0) after 8m19s
[05:41:41.087] Received PubSub notification, asking Buildbucket for the build status
[05:41:41.136] Build:
{
"id": "8824051876298499185",
"builder": {
"project": "r8",
"bucket": "ci",
"builder": "linux-run-on-app-dump_release"
},
"number": 211,
"createdBy": "project:r8",
"createTime": "2022-01-25T15:43:01.145622220Z",
"startTime": "2022-01-26T01:43:02.632637Z",
"endTime": "2022-01-26T05:41:40.224895546Z",
"updateTime": "2022-01-26T05:41:40.224895546Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "r8.googlesource.com",
"project": "r8",
"id": "7d21f1775699ead07581977bfc6aeeeb10360a7a",
"ref": "refs/heads/3.3"
}
},
"canary": true
}
[05:41:41.136] Invocation finished in 13h58m41.746119722s with status SUCCEEDED