[15:42:38.436] New invocation is queued and will start shortly
[15:42:45.798] Starting the invocation (attempt 1)
[15:42:45.901] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[15:42:45.901] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[15:42:45.901] Buildbucket request:
{
"bucket": "luci.fuchsia.prod",
"client_operation_id": "9057067297712906176",
"parameters_json": "{\"builder_name\":\"gcc-arm64-linux\",\"properties\":{\"$recipe_engine/scheduler\":{\"hostname\":\"luci-scheduler.appspot.com\",\"triggers\":[{\"gitiles\":{\"ref\":\"refs/heads/gcc-9-branch\",\"repo\":\"https://gnu.googlesource.com/gcc\",\"revision\":\"4a2e1b3b026461cecec99338ede2f10c4df9959f\"},\"id\":\"https://gnu.googlesource.com/gcc/+/refs/heads/gcc-9-branch@4a2e1b3b026461cecec99338ede2f10c4df9959f\",\"title\":\"4a2e1b3b026461cecec99338ede2f10c4df9959f\",\"url\":\"https://gnu.googlesource.com/gcc/+/4a2e1b3b026461cecec99338ede2f10c4df9959f\"}]},\"branch\":\"refs/heads/gcc-9-branch\",\"repository\":\"https://gnu.googlesource.com/gcc\",\"revision\":\"4a2e1b3b026461cecec99338ede2f10c4df9959f\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:gcc-arm64-linux",
"scheduler_invocation_id:9057067297712906176",
"scheduler_job_id:fuchsia/prod-gcc-arm64-linux",
"user_agent:luci-scheduler",
"buildset:commit/git/4a2e1b3b026461cecec99338ede2f10c4df9959f",
"buildset:commit/gitiles/gnu.googlesource.com/gcc/+/4a2e1b3b026461cecec99338ede2f10c4df9959f",
"gitiles_ref:refs/heads/gcc-9-branch"
]
}
[15:42:46.909] Buildbucket response:
{
"build": {
"bucket": "luci.fuchsia.prod",
"canary_preference": "PROD",
"created_by": "project:fuchsia",
"created_ts": "1578670966003734",
"id": "8891637229111123216",
"parameters_json": "{\"builder_name\": \"gcc-arm64-linux\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/gcc-9-branch\", \"repo\": \"https://gnu.googlesource.com/gcc\", \"revision\": \"4a2e1b3b026461cecec99338ede2f10c4df9959f\"}, \"id\": \"https://gnu.googlesource.com/gcc/+/refs/heads/gcc-9-branch@4a2e1b3b026461cecec99338ede2f10c4df9959f\", \"title\": \"4a2e1b3b026461cecec99338ede2f10c4df9959f\", \"url\": \"https://gnu.googlesource.com/gcc/+/4a2e1b3b026461cecec99338ede2f10c4df9959f\"}]}, \"branch\": \"refs/heads/gcc-9-branch\", \"repository\": \"https://gnu.googlesource.com/gcc\", \"revision\": \"4a2e1b3b026461cecec99338ede2f10c4df9959f\"}}",
"project": "fuchsia",
"result_details_json": "{\"properties\": {}}",
"service_account": "fuchsia-prod-builder@fuchsia-infra.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1578670966475810",
"tags": [
"builder:gcc-arm64-linux",
"buildset:commit/git/4a2e1b3b026461cecec99338ede2f10c4df9959f",
"buildset:commit/gitiles/gnu.googlesource.com/gcc/+/4a2e1b3b026461cecec99338ede2f10c4df9959f",
"gitiles_ref:refs/heads/gcc-9-branch",
"scheduler_invocation_id:9057067297712906176",
"scheduler_job_id:fuchsia/prod-gcc-arm64-linux",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/fuchsia/buildbucket/cr-buildbucket.appspot.com/8891637229111123216/+/annotations",
"swarming_tag:luci_project:fuchsia",
"swarming_tag:recipe_name:gcc_toolchain",
"swarming_tag:recipe_package:fuchsia/infra/recipe_bundles/fuchsia.googlesource.com/infra/recipes",
"swarming_task_id:",
"user_agent:luci-scheduler"
],
"updated_ts": "1578670966475970",
"url": "https://ci.chromium.org/b/8891637229111123216",
"utcnow_ts": "1578670966873934"
}
}
[15:42:46.909] Task URL: https://ci.chromium.org/b/8891637229111123216
[15:42:46.909] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:2:0) after 1m0s
[15:43:40.865] Received PubSub notification, asking Buildbucket for the build status
[15:43:41.122] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:43:46.972] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:2:0)
[15:43:46.972] Timer tick, asking Buildbucket for the build status
[15:43:47.351] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:43:47.351] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:4:0) after 1m0s
[15:44:47.442] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:4:0)
[15:44:47.442] Timer tick, asking Buildbucket for the build status
[15:44:47.834] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:44:47.834] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:5:0) after 1m0s
[15:45:47.902] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:5:0)
[15:45:47.902] Timer tick, asking Buildbucket for the build status
[15:45:48.380] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:45:48.380] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:6:0) after 1m0s
[15:46:48.413] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:6:0)
[15:46:48.413] Timer tick, asking Buildbucket for the build status
[15:46:49.028] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:46:49.028] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:7:0) after 1m0s
[15:47:49.053] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:7:0)
[15:47:49.053] Timer tick, asking Buildbucket for the build status
[15:47:49.350] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:47:49.350] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:8:0) after 1m0s
[15:48:49.401] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:8:0)
[15:48:49.401] Timer tick, asking Buildbucket for the build status
[15:48:49.691] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:48:49.691] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:9:0) after 1m0s
[15:49:49.731] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:9:0)
[15:49:49.731] Timer tick, asking Buildbucket for the build status
[15:49:49.990] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:49:49.990] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:10:0) after 1m0s
[15:50:50.025] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:10:0)
[15:50:50.025] Timer tick, asking Buildbucket for the build status
[15:50:50.135] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:50:50.135] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:11:0) after 1m0s
[15:51:50.187] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:11:0)
[15:51:50.187] Timer tick, asking Buildbucket for the build status
[15:51:50.395] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:51:50.395] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:12:0) after 1m0s
[15:52:50.560] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:12:0)
[15:52:50.560] Timer tick, asking Buildbucket for the build status
[15:52:50.806] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:52:50.806] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:13:0) after 1m0s
[15:53:50.908] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:13:0)
[15:53:50.908] Timer tick, asking Buildbucket for the build status
[15:53:51.032] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:53:51.032] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:14:0) after 1m0s
[15:54:51.054] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:14:0)
[15:54:51.054] Timer tick, asking Buildbucket for the build status
[15:54:51.458] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:54:51.458] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:15:0) after 1m0s
[15:55:51.454] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:15:0)
[15:55:51.454] Timer tick, asking Buildbucket for the build status
[15:55:51.671] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:55:51.671] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:16:0) after 1m0s
[15:56:51.692] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:16:0)
[15:56:51.692] Timer tick, asking Buildbucket for the build status
[15:56:51.861] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:56:51.861] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:17:0) after 1m0s
[15:57:51.882] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:17:0)
[15:57:51.882] Timer tick, asking Buildbucket for the build status
[15:57:52.103] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:57:52.103] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:18:0) after 1m0s
[15:58:52.124] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:18:0)
[15:58:52.124] Timer tick, asking Buildbucket for the build status
[15:58:52.346] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:58:52.346] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:19:0) after 1m0s
[15:59:52.374] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:19:0)
[15:59:52.374] Timer tick, asking Buildbucket for the build status
[15:59:52.502] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:59:52.502] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:20:0) after 1m0s
[16:00:52.558] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:20:0)
[16:00:52.558] Timer tick, asking Buildbucket for the build status
[16:00:52.796] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:00:52.796] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:21:0) after 1m0s
[16:01:53.012] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:21:0)
[16:01:53.012] Timer tick, asking Buildbucket for the build status
[16:01:53.868] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:01:53.868] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:22:0) after 1m0s
[16:02:53.923] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:22:0)
[16:02:53.923] Timer tick, asking Buildbucket for the build status
[16:02:54.163] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:02:54.163] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:23:0) after 1m0s
[16:03:54.298] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:23:0)
[16:03:54.298] Timer tick, asking Buildbucket for the build status
[16:03:55.411] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:03:55.411] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:24:0) after 1m0s
[16:04:55.491] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:24:0)
[16:04:55.491] Timer tick, asking Buildbucket for the build status
[16:04:55.690] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:04:55.690] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:25:0) after 1m0s
[16:05:55.863] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:25:0)
[16:05:55.863] Timer tick, asking Buildbucket for the build status
[16:05:56.121] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:05:56.121] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:26:0) after 1m0s
[16:06:56.436] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:26:0)
[16:06:56.436] Timer tick, asking Buildbucket for the build status
[16:06:56.775] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:06:56.775] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:27:0) after 1m0s
[16:07:56.907] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:27:0)
[16:07:56.907] Timer tick, asking Buildbucket for the build status
[16:07:57.587] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:07:57.587] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:28:0) after 1m0s
[16:08:57.774] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:28:0)
[16:08:57.774] Timer tick, asking Buildbucket for the build status
[16:08:57.894] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:08:57.894] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:29:0) after 1m0s
[16:09:58.030] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:29:0)
[16:09:58.030] Timer tick, asking Buildbucket for the build status
[16:09:58.257] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:09:58.257] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:30:0) after 1m0s
[16:10:58.375] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:30:0)
[16:10:58.375] Timer tick, asking Buildbucket for the build status
[16:10:58.968] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:10:58.968] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:31:0) after 1m0s
[16:11:59.037] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:31:0)
[16:11:59.037] Timer tick, asking Buildbucket for the build status
[16:11:59.306] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:11:59.306] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:32:0) after 1m0s
[16:12:59.358] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:32:0)
[16:12:59.358] Timer tick, asking Buildbucket for the build status
[16:12:59.969] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:12:59.969] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:33:0) after 1m0s
[16:13:59.989] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:33:0)
[16:13:59.989] Timer tick, asking Buildbucket for the build status
[16:14:00.245] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:14:00.245] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:34:0) after 1m0s
[16:15:00.305] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:34:0)
[16:15:00.305] Timer tick, asking Buildbucket for the build status
[16:15:00.432] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:15:00.432] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:35:0) after 1m0s
[16:16:00.517] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:35:0)
[16:16:00.518] Timer tick, asking Buildbucket for the build status
[16:16:00.652] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:16:00.652] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:36:0) after 1m0s
[16:17:00.670] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:36:0)
[16:17:00.670] Timer tick, asking Buildbucket for the build status
[16:17:01.062] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:17:01.062] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:37:0) after 1m0s
[16:18:01.086] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:37:0)
[16:18:01.086] Timer tick, asking Buildbucket for the build status
[16:18:01.286] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:18:01.286] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:38:0) after 1m0s
[16:19:01.298] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:38:0)
[16:19:01.298] Timer tick, asking Buildbucket for the build status
[16:19:02.116] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:19:02.116] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:39:0) after 1m0s
[16:20:02.141] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:39:0)
[16:20:02.141] Timer tick, asking Buildbucket for the build status
[16:20:03.302] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:20:03.302] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:40:0) after 1m0s
[16:21:03.354] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:40:0)
[16:21:03.354] Timer tick, asking Buildbucket for the build status
[16:21:03.837] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:21:03.837] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:41:0) after 1m0s
[16:22:03.952] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:41:0)
[16:22:03.952] Timer tick, asking Buildbucket for the build status
[16:22:04.312] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:22:04.312] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:42:0) after 1m0s
[16:23:04.364] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:42:0)
[16:23:04.364] Timer tick, asking Buildbucket for the build status
[16:23:05.134] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:23:05.134] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:43:0) after 1m0s
[16:24:05.224] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:43:0)
[16:24:05.224] Timer tick, asking Buildbucket for the build status
[16:24:05.504] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:24:05.504] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:44:0) after 1m0s
[16:25:05.600] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:44:0)
[16:25:05.600] Timer tick, asking Buildbucket for the build status
[16:25:05.802] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:25:05.802] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:45:0) after 1m0s
[16:26:05.842] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:45:0)
[16:26:05.842] Timer tick, asking Buildbucket for the build status
[16:26:06.412] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:26:06.412] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:46:0) after 1m0s
[16:27:06.537] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:46:0)
[16:27:06.537] Timer tick, asking Buildbucket for the build status
[16:27:06.723] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:27:06.724] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:47:0) after 1m0s
[16:28:06.747] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:47:0)
[16:28:06.747] Timer tick, asking Buildbucket for the build status
[16:28:07.258] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:28:07.258] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:48:0) after 1m0s
[16:29:07.296] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:48:0)
[16:29:07.296] Timer tick, asking Buildbucket for the build status
[16:29:07.436] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:29:07.436] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:49:0) after 1m0s
[16:30:07.466] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:49:0)
[16:30:07.466] Timer tick, asking Buildbucket for the build status
[16:30:07.579] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:30:07.579] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:50:0) after 1m0s
[16:31:07.630] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:50:0)
[16:31:07.631] Timer tick, asking Buildbucket for the build status
[16:31:07.754] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:31:07.754] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:51:0) after 1m0s
[16:32:07.858] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:51:0)
[16:32:07.858] Timer tick, asking Buildbucket for the build status
[16:32:08.425] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:32:08.425] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:52:0) after 1m0s
[16:33:08.507] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:52:0)
[16:33:08.507] Timer tick, asking Buildbucket for the build status
[16:33:08.676] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:33:08.676] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:53:0) after 1m0s
[16:34:08.692] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:53:0)
[16:34:08.692] Timer tick, asking Buildbucket for the build status
[16:34:09.208] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:34:09.208] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:54:0) after 1m0s
[16:35:09.319] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:54:0)
[16:35:09.319] Timer tick, asking Buildbucket for the build status
[16:35:09.601] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:35:09.601] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:55:0) after 1m0s
[16:36:09.728] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:55:0)
[16:36:09.728] Timer tick, asking Buildbucket for the build status
[16:36:10.247] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:36:10.247] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:56:0) after 1m0s
[16:37:10.360] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:56:0)
[16:37:10.360] Timer tick, asking Buildbucket for the build status
[16:37:10.864] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:37:10.864] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:57:0) after 1m0s
[16:38:11.011] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:57:0)
[16:38:11.011] Timer tick, asking Buildbucket for the build status
[16:38:11.506] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:38:11.506] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:58:0) after 1m0s
[16:39:11.529] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:58:0)
[16:39:11.529] Timer tick, asking Buildbucket for the build status
[16:39:12.026] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:39:12.026] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:59:0) after 1m0s
[16:40:12.085] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:59:0)
[16:40:12.085] Timer tick, asking Buildbucket for the build status
[16:40:12.315] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:40:12.315] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:60:0) after 1m0s
[16:41:12.384] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:60:0)
[16:41:12.384] Timer tick, asking Buildbucket for the build status
[16:41:12.512] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:41:12.512] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:61:0) after 1m0s
[16:42:12.544] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:61:0)
[16:42:12.544] Timer tick, asking Buildbucket for the build status
[16:42:12.809] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:42:12.809] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:62:0) after 1m0s
[16:43:12.863] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:62:0)
[16:43:12.863] Timer tick, asking Buildbucket for the build status
[16:43:13.018] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:43:13.018] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:63:0) after 1m0s
[16:44:13.038] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:63:0)
[16:44:13.038] Timer tick, asking Buildbucket for the build status
[16:44:13.491] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:44:13.491] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:64:0) after 1m0s
[16:45:13.550] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:64:0)
[16:45:13.550] Timer tick, asking Buildbucket for the build status
[16:45:14.188] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:45:14.188] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:65:0) after 1m0s
[16:46:14.214] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:65:0)
[16:46:14.214] Timer tick, asking Buildbucket for the build status
[16:46:14.399] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:46:14.399] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:66:0) after 1m0s
[16:47:14.429] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:66:0)
[16:47:14.429] Timer tick, asking Buildbucket for the build status
[16:47:14.681] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:47:14.681] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:67:0) after 1m0s
[16:48:14.983] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:67:0)
[16:48:14.983] Timer tick, asking Buildbucket for the build status
[16:48:15.183] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:48:15.183] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:68:0) after 1m0s
[16:49:15.212] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:68:0)
[16:49:15.212] Timer tick, asking Buildbucket for the build status
[16:49:15.516] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:49:15.516] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:69:0) after 1m0s
[16:50:15.535] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:69:0)
[16:50:15.535] Timer tick, asking Buildbucket for the build status
[16:50:17.325] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:50:17.325] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:70:0) after 1m0s
[16:51:17.372] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:70:0)
[16:51:17.372] Timer tick, asking Buildbucket for the build status
[16:51:17.729] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:51:17.729] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:71:0) after 1m0s
[16:52:17.858] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:71:0)
[16:52:17.858] Timer tick, asking Buildbucket for the build status
[16:52:18.156] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:52:18.156] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:72:0) after 1m0s
[16:53:18.349] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:72:0)
[16:53:18.349] Timer tick, asking Buildbucket for the build status
[16:53:18.488] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:53:18.488] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:73:0) after 1m0s
[16:54:18.591] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:73:0)
[16:54:18.591] Timer tick, asking Buildbucket for the build status
[16:54:18.725] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:54:18.725] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:74:0) after 1m0s
[16:55:18.928] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:74:0)
[16:55:18.928] Timer tick, asking Buildbucket for the build status
[16:55:19.196] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:55:19.196] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:75:0) after 1m0s
[16:56:19.321] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:75:0)
[16:56:19.321] Timer tick, asking Buildbucket for the build status
[16:56:20.569] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:56:20.569] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:76:0) after 1m0s
[16:57:20.646] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:76:0)
[16:57:20.646] Timer tick, asking Buildbucket for the build status
[16:57:24.149] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:57:24.149] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:77:0) after 1m0s
[16:58:24.201] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:77:0)
[16:58:24.201] Timer tick, asking Buildbucket for the build status
[16:58:24.391] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:58:24.391] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:78:0) after 1m0s
[16:59:24.530] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:78:0)
[16:59:24.530] Timer tick, asking Buildbucket for the build status
[16:59:24.664] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:59:24.664] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:79:0) after 1m0s
[17:00:24.706] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:79:0)
[17:00:24.706] Timer tick, asking Buildbucket for the build status
[17:00:25.002] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:00:25.002] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:80:0) after 1m0s
[17:01:25.142] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:80:0)
[17:01:25.142] Timer tick, asking Buildbucket for the build status
[17:01:25.360] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:01:25.360] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:81:0) after 1m0s
[17:02:25.445] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:81:0)
[17:02:25.445] Timer tick, asking Buildbucket for the build status
[17:02:25.656] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:02:25.656] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:82:0) after 1m0s
[17:03:25.710] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:82:0)
[17:03:25.710] Timer tick, asking Buildbucket for the build status
[17:03:25.918] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:03:25.918] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:83:0) after 1m0s
[17:04:26.089] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:83:0)
[17:04:26.089] Timer tick, asking Buildbucket for the build status
[17:04:26.333] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:04:26.333] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:84:0) after 1m0s
[17:05:26.419] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:84:0)
[17:05:26.419] Timer tick, asking Buildbucket for the build status
[17:05:26.885] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:05:26.885] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:85:0) after 1m0s
[17:06:27.011] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:85:0)
[17:06:27.011] Timer tick, asking Buildbucket for the build status
[17:06:27.142] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:06:27.142] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:86:0) after 1m0s
[17:07:27.255] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:86:0)
[17:07:27.255] Timer tick, asking Buildbucket for the build status
[17:07:27.376] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:07:27.376] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:87:0) after 1m0s
[17:08:27.406] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:87:0)
[17:08:27.406] Timer tick, asking Buildbucket for the build status
[17:08:27.781] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:08:27.781] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:88:0) after 1m0s
[17:09:27.806] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:88:0)
[17:09:27.806] Timer tick, asking Buildbucket for the build status
[17:09:28.025] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:09:28.025] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:89:0) after 1m0s
[17:10:28.062] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:89:0)
[17:10:28.062] Timer tick, asking Buildbucket for the build status
[17:10:28.324] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:10:28.324] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:90:0) after 1m0s
[17:11:28.374] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:90:0)
[17:11:28.374] Timer tick, asking Buildbucket for the build status
[17:11:28.921] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:11:28.921] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:91:0) after 1m0s
[17:12:28.997] Handling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:91:0)
[17:12:28.997] Timer tick, asking Buildbucket for the build status
[17:12:29.251] Build 8891637229111123216: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:12:29.251] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-gcc-arm64-linux:9057067297712906176:92:0) after 1m0s
[17:13:14.894] Received PubSub notification, asking Buildbucket for the build status
[17:13:15.170] Build 8891637229111123216: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[17:13:15.170] Buildbucket build:
{
"build": {
"bucket": "luci.fuchsia.prod",
"canary_preference": "PROD",
"completed_ts": "1578676393201671",
"created_by": "project:fuchsia",
"created_ts": "1578670966003734",
"id": "8891637229111123216",
"parameters_json": "{\"builder_name\": \"gcc-arm64-linux\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/gcc-9-branch\", \"repo\": \"https://gnu.googlesource.com/gcc\", \"revision\": \"4a2e1b3b026461cecec99338ede2f10c4df9959f\"}, \"id\": \"https://gnu.googlesource.com/gcc/+/refs/heads/gcc-9-branch@4a2e1b3b026461cecec99338ede2f10c4df9959f\", \"title\": \"4a2e1b3b026461cecec99338ede2f10c4df9959f\", \"url\": \"https://gnu.googlesource.com/gcc/+/4a2e1b3b026461cecec99338ede2f10c4df9959f\"}]}, \"branch\": \"refs/heads/gcc-9-branch\", \"repository\": \"https://gnu.googlesource.com/gcc\", \"revision\": \"4a2e1b3b026461cecec99338ede2f10c4df9959f\"}}",
"project": "fuchsia",
"result": "SUCCESS",
"result_details_json": "{\"properties\": {\"$recipe_engine/isolated\": {\"server\": \"https://isolateserver.appspot.com\"}, \"$recipe_engine/path\": {\"cache_dir\": \"/b/s/w/ir/cache\", \"temp_dir\": \"/b/s/w/ir/tmp/rt\"}, \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/gcc-9-branch\", \"repo\": \"https://gnu.googlesource.com/gcc\", \"revision\": \"4a2e1b3b026461cecec99338ede2f10c4df9959f\"}, \"id\": \"https://gnu.googlesource.com/gcc/+/refs/heads/gcc-9-branch@4a2e1b3b026461cecec99338ede2f10c4df9959f\", \"title\": \"4a2e1b3b026461cecec99338ede2f10c4df9959f\", \"url\": \"https://gnu.googlesource.com/gcc/+/4a2e1b3b026461cecec99338ede2f10c4df9959f\"}]}, \"$recipe_engine/swarming\": {\"server\": \"https://chromium-swarm.appspot.com\"}, \"bot_id\": \"build413-a9\", \"branch\": \"refs/heads/gcc-9-branch\", \"buildername\": \"gcc-arm64-linux\", \"instance_id\": \"jujO1Lzoie1FS8c_QRc6JAhuL7oIhH-qHycPVVNdng0C\", \"isolated\": \"ac29d31f7df13f9c018bc00929b929a3a78c55a3\", \"mastername\": \"gcc\", \"package\": \"fuchsia/third_party/gcc/linux-arm64\", \"path_config\": \"generic\", \"recipe\": \"gcc_toolchain\", \"repository\": \"https://gnu.googlesource.com/gcc\", \"revision\": \"4a2e1b3b026461cecec99338ede2f10c4df9959f\"}, \"swarming\": {\"bot_dimensions\": {\"caches\": [\"git\", \"vpython\"], \"cores\": [\"256\"], \"cpu\": [\"arm\", \"arm-64\", \"arm64\", \"arm64-64\"], \"gce\": [\"0\"], \"gpu\": [\"1a03\", \"1a03:2000\"], \"id\": [\"build413-a9\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"n1-highcpu-16\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-18.04\"], \"pool\": [\"luci.fuchsia.prod\"], \"python\": [\"2.7.15+\"], \"server_version\": [\"4752-73c7603\"], \"ssd\": [\"1\"], \"zone\": [\"us\", \"us-mtv\", \"us-mtv-chops\", \"us-mtv-chops-a9\"]}}}",
"service_account": "fuchsia-prod-builder@fuchsia-infra.iam.gserviceaccount.com",
"started_ts": "1578671020179611",
"status": "COMPLETED",
"status_changed_ts": "1578676393967344",
"tags": [
"builder:gcc-arm64-linux",
"buildset:commit/git/4a2e1b3b026461cecec99338ede2f10c4df9959f",
"buildset:commit/gitiles/gnu.googlesource.com/gcc/+/4a2e1b3b026461cecec99338ede2f10c4df9959f",
"gitiles_ref:refs/heads/gcc-9-branch",
"scheduler_invocation_id:9057067297712906176",
"scheduler_job_id:fuchsia/prod-gcc-arm64-linux",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/fuchsia/buildbucket/cr-buildbucket.appspot.com/8891637229111123216/+/annotations",
"swarming_tag:luci_project:fuchsia",
"swarming_tag:os:Linux",
"swarming_tag:recipe_name:gcc_toolchain",
"swarming_tag:recipe_package:fuchsia/infra/recipe_bundles/fuchsia.googlesource.com/infra/recipes",
"swarming_task_id:49a8f0dcb18d9710",
"user_agent:luci-scheduler"
],
"updated_ts": "1578676393982045",
"url": "https://ci.chromium.org/b/8891637229111123216",
"utcnow_ts": "1578676395158359"
}
}
[17:13:15.171] Invocation finished in 1h30m36.754889284s with status SUCCEEDED