[11:48:58.316] New invocation is queued and will start shortly
[11:48:59.468] Starting the invocation (attempt 1)
[11:48:59.549] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[11:48:59.549] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[11:48:59.549] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9064692144051416560",
"parameters_json": "{\"builder_name\":\"Deterministic Linux (dbg)\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"5870ac371b429f92c1f579e0131991f6f19f4e4d\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:Deterministic Linux (dbg)",
"scheduler_invocation_id:9064692144051416560",
"scheduler_job_id:chromium/Deterministic Linux (dbg)",
"user_agent:luci-scheduler",
"buildset:commit/git/5870ac371b429f92c1f579e0131991f6f19f4e4d",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/5870ac371b429f92c1f579e0131991f6f19f4e4d",
"gitiles_ref:refs/heads/master"
]
}
[11:49:00.929] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1571399339808137",
"id": "8899262081819568160",
"parameters_json": "{\"builder_name\": \"Deterministic Linux (dbg)\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"5870ac371b429f92c1f579e0131991f6f19f4e4d\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1571399340609907",
"tags": [
"build_address:luci.chromium.ci/Deterministic Linux (dbg)/12057",
"builder:Deterministic Linux (dbg)",
"buildset:commit/git/5870ac371b429f92c1f579e0131991f6f19f4e4d",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/5870ac371b429f92c1f579e0131991f6f19f4e4d",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9064692144051416560",
"scheduler_job_id:chromium/Deterministic Linux (dbg)",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8899262081819568160/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:recipe_name:swarming/deterministic_build",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:",
"user_agent:luci-scheduler"
],
"updated_ts": "1571399340610054",
"url": "https://ci.chromium.org/b/8899262081819568160",
"utcnow_ts": "1571399340901937"
}
}
[11:49:00.929] Task URL: https://ci.chromium.org/b/8899262081819568160
[11:49:00.929] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:2:0) after 1m0s
[11:49:05.288] Received PubSub notification, asking Buildbucket for the build status
[11:49:06.381] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:50:01.091] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:2:0)
[11:50:01.091] Timer tick, asking Buildbucket for the build status
[11:50:02.395] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:50:02.395] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:4:0) after 1m0s
[11:51:02.375] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:4:0)
[11:51:02.375] Timer tick, asking Buildbucket for the build status
[11:51:02.709] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:51:02.709] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:5:0) after 1m0s
[11:52:02.773] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:5:0)
[11:52:02.773] Timer tick, asking Buildbucket for the build status
[11:52:03.329] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:52:03.330] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:6:0) after 1m0s
[11:53:03.361] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:6:0)
[11:53:03.361] Timer tick, asking Buildbucket for the build status
[11:53:03.654] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:53:03.654] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:7:0) after 1m0s
[11:54:03.734] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:7:0)
[11:54:03.735] Timer tick, asking Buildbucket for the build status
[11:54:04.061] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:54:04.061] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:8:0) after 1m0s
[11:55:04.104] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:8:0)
[11:55:04.104] Timer tick, asking Buildbucket for the build status
[11:55:04.597] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:55:04.597] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:9:0) after 1m0s
[11:56:04.667] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:9:0)
[11:56:04.667] Timer tick, asking Buildbucket for the build status
[11:56:05.177] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:56:05.177] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:10:0) after 1m0s
[11:57:05.326] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:10:0)
[11:57:05.326] Timer tick, asking Buildbucket for the build status
[11:57:05.559] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:57:05.559] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:11:0) after 1m0s
[11:58:05.706] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:11:0)
[11:58:05.706] Timer tick, asking Buildbucket for the build status
[11:58:05.886] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:58:05.886] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:12:0) after 1m0s
[11:59:05.976] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:12:0)
[11:59:05.976] Timer tick, asking Buildbucket for the build status
[11:59:06.808] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:59:06.808] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:13:0) after 1m0s
[12:00:07.211] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:13:0)
[12:00:07.211] Timer tick, asking Buildbucket for the build status
[12:00:07.599] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:00:07.599] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:14:0) after 1m0s
[12:01:07.873] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:14:0)
[12:01:07.873] Timer tick, asking Buildbucket for the build status
[12:01:08.483] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:01:08.483] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:15:0) after 1m0s
[12:02:08.597] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:15:0)
[12:02:08.597] Timer tick, asking Buildbucket for the build status
[12:02:08.961] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:02:08.961] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:16:0) after 1m0s
[12:03:09.233] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:16:0)
[12:03:09.233] Timer tick, asking Buildbucket for the build status
[12:03:12.055] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:03:12.055] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:17:0) after 1m0s
[12:04:12.094] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:17:0)
[12:04:12.094] Timer tick, asking Buildbucket for the build status
[12:04:12.340] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:04:12.340] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:18:0) after 1m0s
[12:05:12.360] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:18:0)
[12:05:12.360] Timer tick, asking Buildbucket for the build status
[12:05:12.633] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:05:12.633] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:19:0) after 1m0s
[12:06:12.669] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:19:0)
[12:06:12.669] Timer tick, asking Buildbucket for the build status
[12:06:14.607] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:06:14.607] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:20:0) after 1m0s
[12:07:14.739] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:20:0)
[12:07:14.739] Timer tick, asking Buildbucket for the build status
[12:07:15.308] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:07:15.308] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:21:0) after 1m0s
[12:08:15.481] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:21:0)
[12:08:15.481] Timer tick, asking Buildbucket for the build status
[12:08:16.133] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:08:16.133] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:22:0) after 1m0s
[12:09:16.269] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:22:0)
[12:09:16.269] Timer tick, asking Buildbucket for the build status
[12:09:20.735] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:09:20.735] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:23:0) after 1m0s
[12:10:20.801] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:23:0)
[12:10:20.801] Timer tick, asking Buildbucket for the build status
[12:10:21.058] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:10:21.058] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:24:0) after 1m0s
[12:11:21.079] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:24:0)
[12:11:21.079] Timer tick, asking Buildbucket for the build status
[12:11:21.421] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:11:21.421] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:25:0) after 1m0s
[12:12:21.441] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:25:0)
[12:12:21.441] Timer tick, asking Buildbucket for the build status
[12:12:21.619] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:12:21.619] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:26:0) after 1m0s
[12:13:21.714] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:26:0)
[12:13:21.714] Timer tick, asking Buildbucket for the build status
[12:13:22.082] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:13:22.082] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:27:0) after 1m0s
[12:14:22.092] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:27:0)
[12:14:22.092] Timer tick, asking Buildbucket for the build status
[12:14:22.296] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:14:22.297] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:28:0) after 1m0s
[12:15:22.320] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:28:0)
[12:15:22.320] Timer tick, asking Buildbucket for the build status
[12:15:22.504] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:15:22.504] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:29:0) after 1m0s
[12:16:22.489] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:29:0)
[12:16:22.489] Timer tick, asking Buildbucket for the build status
[12:16:22.708] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:16:22.708] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:30:0) after 1m0s
[12:17:22.700] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:30:0)
[12:17:22.700] Timer tick, asking Buildbucket for the build status
[12:17:23.012] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:17:23.012] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:31:0) after 1m0s
[12:18:23.037] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:31:0)
[12:18:23.037] Timer tick, asking Buildbucket for the build status
[12:18:23.235] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:18:23.235] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:32:0) after 1m0s
[12:19:23.259] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:32:0)
[12:19:23.259] Timer tick, asking Buildbucket for the build status
[12:19:23.630] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:19:23.630] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:33:0) after 1m0s
[12:20:23.653] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:33:0)
[12:20:23.653] Timer tick, asking Buildbucket for the build status
[12:20:24.105] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:20:24.105] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:34:0) after 1m0s
[12:21:24.129] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:34:0)
[12:21:24.129] Timer tick, asking Buildbucket for the build status
[12:21:24.594] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:21:24.594] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:35:0) after 1m0s
[12:22:24.645] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:35:0)
[12:22:24.645] Timer tick, asking Buildbucket for the build status
[12:22:24.915] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:22:24.915] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:36:0) after 1m0s
[12:23:24.934] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:36:0)
[12:23:24.934] Timer tick, asking Buildbucket for the build status
[12:23:25.532] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:23:25.532] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:37:0) after 1m0s
[12:24:25.663] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:37:0)
[12:24:25.663] Timer tick, asking Buildbucket for the build status
[12:24:26.248] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:24:26.248] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:38:0) after 1m0s
[12:25:26.257] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:38:0)
[12:25:26.257] Timer tick, asking Buildbucket for the build status
[12:25:26.712] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:25:26.712] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:39:0) after 1m0s
[12:26:26.742] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:39:0)
[12:26:26.742] Timer tick, asking Buildbucket for the build status
[12:26:27.125] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:26:27.125] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:40:0) after 1m0s
[12:27:27.281] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:40:0)
[12:27:27.281] Timer tick, asking Buildbucket for the build status
[12:27:27.514] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:27:27.514] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:41:0) after 1m0s
[12:28:27.553] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:41:0)
[12:28:27.553] Timer tick, asking Buildbucket for the build status
[12:28:28.744] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:28:28.744] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:42:0) after 1m0s
[12:29:28.868] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:42:0)
[12:29:28.868] Timer tick, asking Buildbucket for the build status
[12:29:29.316] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:29:29.316] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:43:0) after 1m0s
[12:30:29.338] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:43:0)
[12:30:29.338] Timer tick, asking Buildbucket for the build status
[12:30:29.510] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:30:29.510] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:44:0) after 1m0s
[12:31:29.560] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:44:0)
[12:31:29.560] Timer tick, asking Buildbucket for the build status
[12:31:30.653] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:31:30.653] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:45:0) after 1m0s
[12:32:30.687] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:45:0)
[12:32:30.687] Timer tick, asking Buildbucket for the build status
[12:32:31.307] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:32:31.307] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:46:0) after 1m0s
[12:33:31.348] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:46:0)
[12:33:31.348] Timer tick, asking Buildbucket for the build status
[12:33:32.456] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:33:32.456] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:47:0) after 1m0s
[12:34:32.481] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:47:0)
[12:34:32.481] Timer tick, asking Buildbucket for the build status
[12:34:32.802] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:34:32.802] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:48:0) after 1m0s
[12:35:32.824] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:48:0)
[12:35:32.824] Timer tick, asking Buildbucket for the build status
[12:35:33.158] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:35:33.158] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:49:0) after 1m0s
[12:36:33.208] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:49:0)
[12:36:33.208] Timer tick, asking Buildbucket for the build status
[12:36:33.708] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:36:33.708] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:50:0) after 1m0s
[12:37:33.839] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:50:0)
[12:37:33.839] Timer tick, asking Buildbucket for the build status
[12:37:34.417] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:37:34.417] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:51:0) after 1m0s
[12:38:34.449] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:51:0)
[12:38:34.449] Timer tick, asking Buildbucket for the build status
[12:38:35.234] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:38:35.234] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:52:0) after 1m0s
[12:39:35.293] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:52:0)
[12:39:35.293] Timer tick, asking Buildbucket for the build status
[12:39:36.230] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:39:36.230] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:53:0) after 1m0s
[12:40:36.344] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:53:0)
[12:40:36.344] Timer tick, asking Buildbucket for the build status
[12:40:36.559] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:40:36.559] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:54:0) after 1m0s
[12:41:36.601] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:54:0)
[12:41:36.601] Timer tick, asking Buildbucket for the build status
[12:41:36.826] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:41:36.826] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:55:0) after 1m0s
[12:42:36.829] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:55:0)
[12:42:36.829] Timer tick, asking Buildbucket for the build status
[12:42:37.899] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:42:37.899] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:56:0) after 1m0s
[12:43:37.975] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:56:0)
[12:43:37.975] Timer tick, asking Buildbucket for the build status
[12:43:38.916] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:43:38.916] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:57:0) after 1m0s
[12:44:39.019] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:57:0)
[12:44:39.019] Timer tick, asking Buildbucket for the build status
[12:44:39.282] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:44:39.282] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:58:0) after 1m0s
[12:45:39.325] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:58:0)
[12:45:39.325] Timer tick, asking Buildbucket for the build status
[12:45:39.880] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:45:39.880] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:59:0) after 1m0s
[12:46:39.906] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:59:0)
[12:46:39.906] Timer tick, asking Buildbucket for the build status
[12:46:40.446] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:46:40.446] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:60:0) after 1m0s
[12:47:40.506] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:60:0)
[12:47:40.506] Timer tick, asking Buildbucket for the build status
[12:47:40.908] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:47:40.908] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:61:0) after 1m0s
[12:48:40.933] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:61:0)
[12:48:40.934] Timer tick, asking Buildbucket for the build status
[12:48:41.321] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:48:41.321] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:62:0) after 1m0s
[12:49:41.446] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:62:0)
[12:49:41.446] Timer tick, asking Buildbucket for the build status
[12:49:41.648] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:49:41.648] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:63:0) after 1m0s
[12:50:41.776] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:63:0)
[12:50:41.776] Timer tick, asking Buildbucket for the build status
[12:50:43.523] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:50:43.523] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:64:0) after 1m0s
[12:51:43.536] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:64:0)
[12:51:43.536] Timer tick, asking Buildbucket for the build status
[12:51:43.806] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:51:43.806] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:65:0) after 1m0s
[12:52:43.822] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:65:0)
[12:52:43.822] Timer tick, asking Buildbucket for the build status
[12:52:44.946] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:52:44.946] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:66:0) after 1m0s
[12:53:45.045] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:66:0)
[12:53:45.045] Timer tick, asking Buildbucket for the build status
[12:53:45.481] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:53:45.481] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:67:0) after 1m0s
[12:54:45.548] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:67:0)
[12:54:45.548] Timer tick, asking Buildbucket for the build status
[12:54:46.365] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:54:46.365] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:68:0) after 1m0s
[12:55:46.364] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:68:0)
[12:55:46.364] Timer tick, asking Buildbucket for the build status
[12:55:47.929] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:55:47.929] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:69:0) after 1m0s
[12:56:47.959] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:69:0)
[12:56:47.959] Timer tick, asking Buildbucket for the build status
[12:56:48.651] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:56:48.651] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:70:0) after 1m0s
[12:57:48.691] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:70:0)
[12:57:48.691] Timer tick, asking Buildbucket for the build status
[12:57:48.993] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:57:48.993] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:71:0) after 1m0s
[12:58:49.022] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:71:0)
[12:58:49.022] Timer tick, asking Buildbucket for the build status
[12:58:49.316] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:58:49.316] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:72:0) after 1m0s
[12:59:49.411] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:72:0)
[12:59:49.411] Timer tick, asking Buildbucket for the build status
[12:59:50.208] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:59:50.208] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:73:0) after 1m0s
[13:00:50.248] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:73:0)
[13:00:50.248] Timer tick, asking Buildbucket for the build status
[13:00:50.716] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:00:50.716] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:74:0) after 1m0s
[13:01:50.893] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:74:0)
[13:01:50.893] Timer tick, asking Buildbucket for the build status
[13:01:51.930] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:01:51.930] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:75:0) after 1m0s
[13:02:52.145] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:75:0)
[13:02:52.145] Timer tick, asking Buildbucket for the build status
[13:02:53.090] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:02:53.090] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:76:0) after 1m0s
[13:03:53.210] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:76:0)
[13:03:53.210] Timer tick, asking Buildbucket for the build status
[13:03:53.459] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:03:53.459] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:77:0) after 1m0s
[13:04:53.484] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:77:0)
[13:04:53.484] Timer tick, asking Buildbucket for the build status
[13:04:56.249] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:04:56.249] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:78:0) after 1m0s
[13:05:56.261] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:78:0)
[13:05:56.261] Timer tick, asking Buildbucket for the build status
[13:05:56.675] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:05:56.675] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:79:0) after 1m0s
[13:06:56.749] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:79:0)
[13:06:56.749] Timer tick, asking Buildbucket for the build status
[13:06:57.058] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:06:57.058] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:80:0) after 1m0s
[13:07:57.190] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:80:0)
[13:07:57.190] Timer tick, asking Buildbucket for the build status
[13:07:57.745] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:07:57.745] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:81:0) after 1m0s
[13:08:57.741] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:81:0)
[13:08:57.741] Timer tick, asking Buildbucket for the build status
[13:08:57.973] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:08:57.973] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:82:0) after 1m0s
[13:09:58.087] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:82:0)
[13:09:58.087] Timer tick, asking Buildbucket for the build status
[13:09:58.281] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:09:58.281] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:83:0) after 1m0s
[13:10:58.345] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:83:0)
[13:10:58.345] Timer tick, asking Buildbucket for the build status
[13:11:01.447] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:11:01.447] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:84:0) after 1m0s
[13:12:01.472] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:84:0)
[13:12:01.472] Timer tick, asking Buildbucket for the build status
[13:12:02.060] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:12:02.060] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:85:0) after 1m0s
[13:13:02.116] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:85:0)
[13:13:02.116] Timer tick, asking Buildbucket for the build status
[13:13:02.345] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:13:02.345] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:86:0) after 1m0s
[13:14:02.444] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:86:0)
[13:14:02.444] Timer tick, asking Buildbucket for the build status
[13:14:02.627] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:14:02.627] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:87:0) after 1m0s
[13:15:02.689] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:87:0)
[13:15:02.689] Timer tick, asking Buildbucket for the build status
[13:15:03.506] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:15:03.506] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:88:0) after 1m0s
[13:16:03.536] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:88:0)
[13:16:03.536] Timer tick, asking Buildbucket for the build status
[13:16:03.835] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:16:03.835] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:89:0) after 1m0s
[13:17:03.863] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:89:0)
[13:17:03.863] Timer tick, asking Buildbucket for the build status
[13:17:04.213] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:17:04.213] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:90:0) after 1m0s
[13:18:04.317] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:90:0)
[13:18:04.317] Timer tick, asking Buildbucket for the build status
[13:18:04.738] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:18:04.738] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:91:0) after 1m0s
[13:19:04.768] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:91:0)
[13:19:04.769] Timer tick, asking Buildbucket for the build status
[13:19:05.154] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:19:05.154] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:92:0) after 1m0s
[13:20:05.166] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:92:0)
[13:20:05.166] Timer tick, asking Buildbucket for the build status
[13:20:05.352] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:20:05.352] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:93:0) after 1m0s
[13:21:05.428] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:93:0)
[13:21:05.428] Timer tick, asking Buildbucket for the build status
[13:21:05.632] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:21:05.632] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:94:0) after 1m0s
[13:22:05.658] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:94:0)
[13:22:05.658] Timer tick, asking Buildbucket for the build status
[13:22:05.882] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:22:05.882] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:95:0) after 1m0s
[13:23:05.928] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:95:0)
[13:23:05.928] Timer tick, asking Buildbucket for the build status
[13:23:06.628] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:23:06.628] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:96:0) after 1m0s
[13:24:06.718] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:96:0)
[13:24:06.718] Timer tick, asking Buildbucket for the build status
[13:24:09.929] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:24:09.930] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:97:0) after 1m0s
[13:25:10.001] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:97:0)
[13:25:10.001] Timer tick, asking Buildbucket for the build status
[13:25:10.196] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:25:10.196] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:98:0) after 1m0s
[13:26:10.230] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:98:0)
[13:26:10.230] Timer tick, asking Buildbucket for the build status
[13:26:10.657] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:26:10.657] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:99:0) after 1m0s
[13:27:10.678] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:99:0)
[13:27:10.678] Timer tick, asking Buildbucket for the build status
[13:27:10.888] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:27:10.888] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:100:0) after 1m0s
[13:28:10.918] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:100:0)
[13:28:10.918] Timer tick, asking Buildbucket for the build status
[13:28:11.235] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:28:11.235] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:101:0) after 1m0s
[13:29:11.260] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:101:0)
[13:29:11.260] Timer tick, asking Buildbucket for the build status
[13:29:11.837] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:29:11.837] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:102:0) after 1m0s
[13:30:11.867] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:102:0)
[13:30:11.867] Timer tick, asking Buildbucket for the build status
[13:30:15.706] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:30:15.706] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:103:0) after 1m0s
[13:31:15.738] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:103:0)
[13:31:15.738] Timer tick, asking Buildbucket for the build status
[13:31:15.980] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:31:15.980] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:104:0) after 1m0s
[13:32:16.150] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:104:0)
[13:32:16.150] Timer tick, asking Buildbucket for the build status
[13:32:17.404] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:32:17.404] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:105:0) after 1m0s
[13:33:17.456] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:105:0)
[13:33:17.456] Timer tick, asking Buildbucket for the build status
[13:33:17.661] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:33:17.661] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:106:0) after 1m0s
[13:34:18.042] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:106:0)
[13:34:18.042] Timer tick, asking Buildbucket for the build status
[13:34:18.600] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:34:18.600] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:107:0) after 1m0s
[13:35:18.606] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:107:0)
[13:35:18.606] Timer tick, asking Buildbucket for the build status
[13:35:18.939] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:35:18.939] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:108:0) after 1m0s
[13:36:18.960] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:108:0)
[13:36:18.960] Timer tick, asking Buildbucket for the build status
[13:36:19.194] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:36:19.194] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:109:0) after 1m0s
[13:37:19.214] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:109:0)
[13:37:19.214] Timer tick, asking Buildbucket for the build status
[13:37:19.489] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:37:19.489] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:110:0) after 1m0s
[13:38:19.580] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:110:0)
[13:38:19.580] Timer tick, asking Buildbucket for the build status
[13:38:19.888] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:38:19.888] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:111:0) after 1m0s
[13:39:19.947] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:111:0)
[13:39:19.947] Timer tick, asking Buildbucket for the build status
[13:39:20.883] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:39:20.883] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:112:0) after 1m0s
[13:40:21.023] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:112:0)
[13:40:21.023] Timer tick, asking Buildbucket for the build status
[13:40:23.076] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:40:23.076] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:113:0) after 1m0s
[13:41:23.203] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:113:0)
[13:41:23.203] Timer tick, asking Buildbucket for the build status
[13:41:24.596] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:41:24.596] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:114:0) after 1m0s
[13:42:24.638] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:114:0)
[13:42:24.638] Timer tick, asking Buildbucket for the build status
[13:42:25.407] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:42:25.407] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:115:0) after 1m0s
[13:43:25.534] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:115:0)
[13:43:25.534] Timer tick, asking Buildbucket for the build status
[13:43:25.853] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:43:25.853] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:116:0) after 1m0s
[13:44:25.879] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:116:0)
[13:44:25.879] Timer tick, asking Buildbucket for the build status
[13:44:26.110] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:44:26.110] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:117:0) after 1m0s
[13:45:26.152] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:117:0)
[13:45:26.152] Timer tick, asking Buildbucket for the build status
[13:45:26.948] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:45:26.948] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:118:0) after 1m0s
[13:46:27.006] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:118:0)
[13:46:27.006] Timer tick, asking Buildbucket for the build status
[13:46:27.212] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:46:27.212] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:119:0) after 1m0s
[13:47:27.238] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:119:0)
[13:47:27.238] Timer tick, asking Buildbucket for the build status
[13:47:27.884] Build 8899262081819568160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:47:27.884] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux (dbg):9064692144051416560:120:0) after 1m0s
[13:47:42.269] Received PubSub notification, asking Buildbucket for the build status
[13:47:42.398] Build 8899262081819568160: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[13:47:42.398] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1571406456813105",
"created_by": "project:chromium",
"created_ts": "1571399339808137",
"id": "8899262081819568160",
"parameters_json": "{\"builder_name\": \"Deterministic Linux (dbg)\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"5870ac371b429f92c1f579e0131991f6f19f4e4d\"}}",
"project": "chromium",
"result": "SUCCESS",
"result_details_json": "{\"properties\": {\"$build/goma\": {\"jobs\": 500.0, \"rpc_extra_params\": \"?prod\", \"server_host\": \"goma.chromium.org\"}, \"$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}, \"bot_id\": \"luci-chromium-ci-xenial-us-central1-b-32-1-kcvm\", \"branch\": \"refs/heads/master\", \"buildername\": \"Deterministic Linux (dbg)\", \"buildnumber\": 12057, \"got_angle_revision\": \"c6db4a035a17fd50c40bdb547840e4d8d21595c2\", \"got_dawn_revision\": \"8d000e0cc230663dbeae86f59aaa16fc91b1eac1\", \"got_nacl_revision\": \"3651f6c52037c96e034cc422746768d59182bff3\", \"got_revision\": \"5870ac371b429f92c1f579e0131991f6f19f4e4d\", \"got_revision_cp\": \"refs/heads/master@{#707330}\", \"got_swarming_client_revision\": \"885b3febcc170a60f25795304e60927b77d1e92d\", \"got_v8_revision\": \"be181e241c6da9baa49a424b7d91613c8ebf76f8\", \"got_v8_revision_cp\": \"refs/heads/7.9.317@{#1}\", \"got_webrtc_revision\": \"119e2197b75efa28a901231d4812258940a98a16\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#29530}\", \"mastername\": \"chromium.linux\", \"path_config\": \"generic\", \"recipe\": \"swarming/deterministic_build\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"5870ac371b429f92c1f579e0131991f6f19f4e4d\"}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_0264569d20b29e1d5e6df044c8d1223ed84f9f22180c83dac41e8db0ff2b71db_v2\", \"builder_39819929c28edbb94cfd890831720319bcf41d58e7ee63cb8a54e18e1fdfd830_v2\", \"builder_940b8dd4638ac05ec7d44839e381a2baf02720b3eac518443ac04ffe6b1809c0_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"32\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gpu\": [\"none\"], \"id\": [\"luci-chromium-ci-xenial-us-central1-b-32-1-kcvm\"], \"image\": [\"chrome-xenial-19100400-6cc5b08ab04\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"n1-standard-32\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-16.04\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.12\"], \"server_version\": [\"4512-670bc38\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1571399344425509",
"status": "COMPLETED",
"status_changed_ts": "1571406461743857",
"tags": [
"build_address:luci.chromium.ci/Deterministic Linux (dbg)/12057",
"builder:Deterministic Linux (dbg)",
"buildset:commit/git/5870ac371b429f92c1f579e0131991f6f19f4e4d",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/5870ac371b429f92c1f579e0131991f6f19f4e4d",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9064692144051416560",
"scheduler_job_id:chromium/Deterministic Linux (dbg)",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8899262081819568160/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:os:Linux",
"swarming_tag:recipe_name:swarming/deterministic_build",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:47f7849ec2b4aa10",
"user_agent:luci-scheduler"
],
"updated_ts": "1571406461750244",
"url": "https://ci.chromium.org/b/8899262081819568160",
"utcnow_ts": "1571406462389925"
}
}
[13:47:42.398] Invocation finished in 1h58m44.102110592s with status SUCCEEDED