[22:16:40.504] New invocation is queued and will start shortly
[22:16:42.058] Starting the invocation (attempt 1)
[22:16:42.098] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[22:16:42.098] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[22:16:42.098] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9057042507203298784",
"parameters_json": "{\"builder_name\":\"Deterministic Linux\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"011363481ff9ae207864793b7e5b1fad47d31112\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:Deterministic Linux",
"scheduler_invocation_id:9057042507203298784",
"scheduler_job_id:chromium/Deterministic Linux",
"user_agent:luci-scheduler",
"buildset:commit/git/011363481ff9ae207864793b7e5b1fad47d31112",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/011363481ff9ae207864793b7e5b1fad47d31112",
"gitiles_ref:refs/heads/master"
]
}
[22:16:44.482] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1578694603247544",
"id": "8891612443664218112",
"parameters_json": "{\"builder_name\": \"Deterministic Linux\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"011363481ff9ae207864793b7e5b1fad47d31112\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1578694604067346",
"tags": [
"build_address:luci.chromium.ci/Deterministic Linux/26419",
"builder:Deterministic Linux",
"buildset:commit/git/011363481ff9ae207864793b7e5b1fad47d31112",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/011363481ff9ae207864793b7e5b1fad47d31112",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9057042507203298784",
"scheduler_job_id:chromium/Deterministic Linux",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8891612443664218112/+/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": "1578694604067789",
"url": "https://ci.chromium.org/b/8891612443664218112",
"utcnow_ts": "1578694604458597"
}
}
[22:16:44.482] Task URL: https://ci.chromium.org/b/8891612443664218112
[22:16:44.482] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:2:0) after 1m0s
[22:17:09.779] Received PubSub notification, asking Buildbucket for the build status
[22:17:09.950] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:17:44.479] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:2:0)
[22:17:44.479] Timer tick, asking Buildbucket for the build status
[22:17:45.528] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:17:45.528] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:4:0) after 1m0s
[22:18:45.629] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:4:0)
[22:18:45.629] Timer tick, asking Buildbucket for the build status
[22:18:45.870] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:18:45.870] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:5:0) after 1m0s
[22:19:45.951] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:5:0)
[22:19:45.951] Timer tick, asking Buildbucket for the build status
[22:19:46.119] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:19:46.119] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:6:0) after 1m0s
[22:20:46.161] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:6:0)
[22:20:46.161] Timer tick, asking Buildbucket for the build status
[22:20:47.875] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:20:47.875] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:7:0) after 1m0s
[22:21:47.929] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:7:0)
[22:21:47.930] Timer tick, asking Buildbucket for the build status
[22:21:48.462] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:21:48.462] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:8:0) after 1m0s
[22:22:48.513] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:8:0)
[22:22:48.513] Timer tick, asking Buildbucket for the build status
[22:22:48.824] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:22:48.824] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:9:0) after 1m0s
[22:23:48.893] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:9:0)
[22:23:48.893] Timer tick, asking Buildbucket for the build status
[22:23:51.234] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:23:51.234] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:10:0) after 1m0s
[22:24:51.420] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:10:0)
[22:24:51.420] Timer tick, asking Buildbucket for the build status
[22:24:51.758] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:24:51.758] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:11:0) after 1m0s
[22:25:51.781] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:11:0)
[22:25:51.781] Timer tick, asking Buildbucket for the build status
[22:25:53.186] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:25:53.186] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:12:0) after 1m0s
[22:26:53.198] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:12:0)
[22:26:53.198] Timer tick, asking Buildbucket for the build status
[22:26:53.496] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:26:53.496] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:13:0) after 1m0s
[22:27:53.549] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:13:0)
[22:27:53.549] Timer tick, asking Buildbucket for the build status
[22:27:54.729] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:27:54.729] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:14:0) after 1m0s
[22:28:54.770] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:14:0)
[22:28:54.770] Timer tick, asking Buildbucket for the build status
[22:28:54.999] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:28:54.999] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:15:0) after 1m0s
[22:29:55.058] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:15:0)
[22:29:55.058] Timer tick, asking Buildbucket for the build status
[22:29:55.571] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:29:55.571] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:16:0) after 1m0s
[22:30:55.609] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:16:0)
[22:30:55.609] Timer tick, asking Buildbucket for the build status
[22:30:55.894] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:30:55.894] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:17:0) after 1m0s
[22:31:55.941] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:17:0)
[22:31:55.941] Timer tick, asking Buildbucket for the build status
[22:31:56.161] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:31:56.161] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:18:0) after 1m0s
[22:32:56.263] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:18:0)
[22:32:56.263] Timer tick, asking Buildbucket for the build status
[22:32:57.753] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:32:57.753] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:19:0) after 1m0s
[22:33:57.885] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:19:0)
[22:33:57.885] Timer tick, asking Buildbucket for the build status
[22:33:58.168] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:33:58.168] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:20:0) after 1m0s
[22:34:58.258] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:20:0)
[22:34:58.258] Timer tick, asking Buildbucket for the build status
[22:34:59.352] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:34:59.352] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:21:0) after 1m0s
[22:35:59.457] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:21:0)
[22:35:59.457] Timer tick, asking Buildbucket for the build status
[22:35:59.673] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:35:59.673] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:22:0) after 1m0s
[22:36:59.712] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:22:0)
[22:36:59.712] Timer tick, asking Buildbucket for the build status
[22:37:00.190] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:37:00.190] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:23:0) after 1m0s
[22:38:00.252] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:23:0)
[22:38:00.252] Timer tick, asking Buildbucket for the build status
[22:38:00.454] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:38:00.454] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:24:0) after 1m0s
[22:39:00.539] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:24:0)
[22:39:00.539] Timer tick, asking Buildbucket for the build status
[22:39:00.707] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:39:00.707] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:25:0) after 1m0s
[22:40:00.865] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:25:0)
[22:40:00.865] Timer tick, asking Buildbucket for the build status
[22:40:01.215] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:40:01.215] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:26:0) after 1m0s
[22:41:01.217] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:26:0)
[22:41:01.217] Timer tick, asking Buildbucket for the build status
[22:41:01.554] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:41:01.554] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:27:0) after 1m0s
[22:42:01.927] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:27:0)
[22:42:01.927] Timer tick, asking Buildbucket for the build status
[22:42:02.503] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:42:02.503] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:28:0) after 1m0s
[22:43:02.677] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:28:0)
[22:43:02.677] Timer tick, asking Buildbucket for the build status
[22:43:03.066] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:43:03.066] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:29:0) after 1m0s
[22:44:03.123] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:29:0)
[22:44:03.123] Timer tick, asking Buildbucket for the build status
[22:44:03.534] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:44:03.534] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:30:0) after 1m0s
[22:45:03.579] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:30:0)
[22:45:03.579] Timer tick, asking Buildbucket for the build status
[22:45:03.820] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:45:03.820] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:31:0) after 1m0s
[22:46:03.855] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:31:0)
[22:46:03.855] Timer tick, asking Buildbucket for the build status
[22:46:04.042] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:46:04.042] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:32:0) after 1m0s
[22:47:04.068] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:32:0)
[22:47:04.068] Timer tick, asking Buildbucket for the build status
[22:47:04.658] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:47:04.658] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:33:0) after 1m0s
[22:48:04.708] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:33:0)
[22:48:04.708] Timer tick, asking Buildbucket for the build status
[22:48:06.118] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:48:06.118] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:34:0) after 1m0s
[22:49:06.142] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:34:0)
[22:49:06.142] Timer tick, asking Buildbucket for the build status
[22:49:06.396] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:49:06.396] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:35:0) after 1m0s
[22:50:06.426] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:35:0)
[22:50:06.426] Timer tick, asking Buildbucket for the build status
[22:50:06.575] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:50:06.575] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:36:0) after 1m0s
[22:51:06.634] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:36:0)
[22:51:06.634] Timer tick, asking Buildbucket for the build status
[22:51:07.080] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:51:07.081] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:37:0) after 1m0s
[22:52:07.101] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:37:0)
[22:52:07.101] Timer tick, asking Buildbucket for the build status
[22:52:07.555] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:52:07.555] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:38:0) after 1m0s
[22:53:07.579] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:38:0)
[22:53:07.579] Timer tick, asking Buildbucket for the build status
[22:53:07.906] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:53:07.906] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:39:0) after 1m0s
[22:54:07.926] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:39:0)
[22:54:07.926] Timer tick, asking Buildbucket for the build status
[22:54:08.746] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:54:08.746] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:40:0) after 1m0s
[22:55:08.761] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:40:0)
[22:55:08.761] Timer tick, asking Buildbucket for the build status
[22:55:09.448] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:55:09.448] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:41:0) after 1m0s
[22:56:09.485] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:41:0)
[22:56:09.485] Timer tick, asking Buildbucket for the build status
[22:56:09.625] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:56:09.625] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:42:0) after 1m0s
[22:57:09.873] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:42:0)
[22:57:09.873] Timer tick, asking Buildbucket for the build status
[22:57:10.108] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:57:10.108] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:43:0) after 1m0s
[22:58:10.456] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:43:0)
[22:58:10.456] Timer tick, asking Buildbucket for the build status
[22:58:10.903] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:58:10.903] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:44:0) after 1m0s
[22:59:11.369] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:44:0)
[22:59:11.369] Timer tick, asking Buildbucket for the build status
[22:59:11.537] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:59:11.537] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:45:0) after 1m0s
[23:00:11.674] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:45:0)
[23:00:11.674] Timer tick, asking Buildbucket for the build status
[23:00:12.079] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:00:12.080] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:46:0) after 1m0s
[23:01:12.171] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:46:0)
[23:01:12.171] Timer tick, asking Buildbucket for the build status
[23:01:13.425] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:01:13.425] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:47:0) after 1m0s
[23:02:13.441] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:47:0)
[23:02:13.441] Timer tick, asking Buildbucket for the build status
[23:02:13.914] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:02:13.914] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:48:0) after 1m0s
[23:03:14.049] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:48:0)
[23:03:14.049] Timer tick, asking Buildbucket for the build status
[23:03:14.234] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:03:14.234] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:49:0) after 1m0s
[23:04:14.278] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:49:0)
[23:04:14.278] Timer tick, asking Buildbucket for the build status
[23:04:14.707] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:04:14.707] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:50:0) after 1m0s
[23:05:14.733] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:50:0)
[23:05:14.733] Timer tick, asking Buildbucket for the build status
[23:05:14.852] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:05:14.852] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:51:0) after 1m0s
[23:06:14.947] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:51:0)
[23:06:14.947] Timer tick, asking Buildbucket for the build status
[23:06:15.202] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:06:15.202] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:52:0) after 1m0s
[23:07:15.270] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:52:0)
[23:07:15.270] Timer tick, asking Buildbucket for the build status
[23:07:15.869] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:07:15.869] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:53:0) after 1m0s
[23:08:15.909] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:53:0)
[23:08:15.909] Timer tick, asking Buildbucket for the build status
[23:08:16.513] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:08:16.513] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:54:0) after 1m0s
[23:09:16.549] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:54:0)
[23:09:16.549] Timer tick, asking Buildbucket for the build status
[23:09:16.733] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:09:16.734] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:55:0) after 1m0s
[23:10:16.754] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:55:0)
[23:10:16.754] Timer tick, asking Buildbucket for the build status
[23:10:17.921] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:10:17.921] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:56:0) after 1m0s
[23:11:17.960] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:56:0)
[23:11:17.960] Timer tick, asking Buildbucket for the build status
[23:11:18.427] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:11:18.427] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:57:0) after 1m0s
[23:12:18.458] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:57:0)
[23:12:18.458] Timer tick, asking Buildbucket for the build status
[23:12:18.701] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:12:18.701] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:58:0) after 1m0s
[23:13:18.713] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:58:0)
[23:13:18.713] Timer tick, asking Buildbucket for the build status
[23:13:18.930] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:13:18.930] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:59:0) after 1m0s
[23:14:18.958] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:59:0)
[23:14:18.958] Timer tick, asking Buildbucket for the build status
[23:14:19.179] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:14:19.179] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:60:0) after 1m0s
[23:15:19.268] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:60:0)
[23:15:19.268] Timer tick, asking Buildbucket for the build status
[23:15:19.473] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:15:19.473] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:61:0) after 1m0s
[23:16:19.531] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:61:0)
[23:16:19.531] Timer tick, asking Buildbucket for the build status
[23:16:19.721] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:16:19.721] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:62:0) after 1m0s
[23:17:19.790] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:62:0)
[23:17:19.790] Timer tick, asking Buildbucket for the build status
[23:17:19.993] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:17:19.993] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:63:0) after 1m0s
[23:18:20.023] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:63:0)
[23:18:20.023] Timer tick, asking Buildbucket for the build status
[23:18:20.270] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:18:20.270] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:64:0) after 1m0s
[23:19:20.296] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:64:0)
[23:19:20.296] Timer tick, asking Buildbucket for the build status
[23:19:20.518] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:19:20.518] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:65:0) after 1m0s
[23:20:20.550] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:65:0)
[23:20:20.550] Timer tick, asking Buildbucket for the build status
[23:20:20.857] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:20:20.857] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:66:0) after 1m0s
[23:21:20.993] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:66:0)
[23:21:20.993] Timer tick, asking Buildbucket for the build status
[23:21:21.623] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:21:21.623] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:67:0) after 1m0s
[23:22:21.759] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:67:0)
[23:22:21.759] Timer tick, asking Buildbucket for the build status
[23:22:22.844] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:22:22.844] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:68:0) after 1m0s
[23:23:22.885] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:68:0)
[23:23:22.885] Timer tick, asking Buildbucket for the build status
[23:23:24.027] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:23:24.027] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:69:0) after 1m0s
[23:24:24.051] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:69:0)
[23:24:24.051] Timer tick, asking Buildbucket for the build status
[23:24:25.742] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:24:25.742] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:70:0) after 1m0s
[23:25:25.861] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:70:0)
[23:25:25.861] Timer tick, asking Buildbucket for the build status
[23:25:25.967] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:25:25.967] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:71:0) after 1m0s
[23:26:26.068] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:71:0)
[23:26:26.068] Timer tick, asking Buildbucket for the build status
[23:26:26.248] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:26:26.248] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:72:0) after 1m0s
[23:27:26.299] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:72:0)
[23:27:26.299] Timer tick, asking Buildbucket for the build status
[23:27:26.746] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:27:26.746] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:73:0) after 1m0s
[23:28:26.775] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:73:0)
[23:28:26.775] Timer tick, asking Buildbucket for the build status
[23:28:27.043] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:28:27.043] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:74:0) after 1m0s
[23:29:27.063] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:74:0)
[23:29:27.063] Timer tick, asking Buildbucket for the build status
[23:29:27.322] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:29:27.322] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:75:0) after 1m0s
[23:30:27.343] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:75:0)
[23:30:27.343] Timer tick, asking Buildbucket for the build status
[23:30:27.600] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:30:27.600] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:76:0) after 1m0s
[23:31:27.682] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:76:0)
[23:31:27.682] Timer tick, asking Buildbucket for the build status
[23:31:28.209] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:31:28.209] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:77:0) after 1m0s
[23:32:28.272] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:77:0)
[23:32:28.272] Timer tick, asking Buildbucket for the build status
[23:32:28.753] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:32:28.753] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:78:0) after 1m0s
[23:33:28.843] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:78:0)
[23:33:28.843] Timer tick, asking Buildbucket for the build status
[23:33:29.071] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:33:29.071] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:79:0) after 1m0s
[23:34:29.162] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:79:0)
[23:34:29.162] Timer tick, asking Buildbucket for the build status
[23:34:29.359] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:34:29.359] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:80:0) after 1m0s
[23:35:29.483] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:80:0)
[23:35:29.483] Timer tick, asking Buildbucket for the build status
[23:35:29.868] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:35:29.868] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:81:0) after 1m0s
[23:36:29.949] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:81:0)
[23:36:29.949] Timer tick, asking Buildbucket for the build status
[23:36:30.276] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:36:30.276] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:82:0) after 1m0s
[23:37:30.430] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:82:0)
[23:37:30.430] Timer tick, asking Buildbucket for the build status
[23:37:32.321] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:37:32.321] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:83:0) after 1m0s
[23:38:32.781] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:83:0)
[23:38:32.781] Timer tick, asking Buildbucket for the build status
[23:38:33.084] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:38:33.084] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:84:0) after 1m0s
[23:39:33.530] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:84:0)
[23:39:33.530] Timer tick, asking Buildbucket for the build status
[23:39:33.713] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:39:33.713] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:85:0) after 1m0s
[23:40:33.894] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:85:0)
[23:40:33.894] Timer tick, asking Buildbucket for the build status
[23:40:34.085] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:40:34.085] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:86:0) after 1m0s
[23:41:34.181] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:86:0)
[23:41:34.181] Timer tick, asking Buildbucket for the build status
[23:41:34.345] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:41:34.345] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:87:0) after 1m0s
[23:42:34.392] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:87:0)
[23:42:34.392] Timer tick, asking Buildbucket for the build status
[23:42:34.603] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:42:34.603] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:88:0) after 1m0s
[23:43:34.686] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:88:0)
[23:43:34.686] Timer tick, asking Buildbucket for the build status
[23:43:34.924] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:43:34.924] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:89:0) after 1m0s
[23:44:34.960] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:89:0)
[23:44:34.960] Timer tick, asking Buildbucket for the build status
[23:44:35.713] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:44:35.713] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:90:0) after 1m0s
[23:45:35.771] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:90:0)
[23:45:35.771] Timer tick, asking Buildbucket for the build status
[23:45:36.267] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:45:36.267] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:91:0) after 1m0s
[23:46:36.331] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:91:0)
[23:46:36.331] Timer tick, asking Buildbucket for the build status
[23:46:36.591] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:46:36.591] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:92:0) after 1m0s
[23:47:36.663] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:92:0)
[23:47:36.663] Timer tick, asking Buildbucket for the build status
[23:47:37.461] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:47:37.461] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:93:0) after 1m0s
[23:48:37.503] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:93:0)
[23:48:37.503] Timer tick, asking Buildbucket for the build status
[23:48:37.685] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:48:37.685] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:94:0) after 1m0s
[23:49:37.714] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:94:0)
[23:49:37.714] Timer tick, asking Buildbucket for the build status
[23:49:38.050] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:49:38.050] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:95:0) after 1m0s
[23:50:38.076] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:95:0)
[23:50:38.076] Timer tick, asking Buildbucket for the build status
[23:50:38.454] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:50:38.454] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:96:0) after 1m0s
[23:51:38.522] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:96:0)
[23:51:38.522] Timer tick, asking Buildbucket for the build status
[23:51:38.879] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:51:38.879] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:97:0) after 1m0s
[23:52:38.955] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:97:0)
[23:52:38.955] Timer tick, asking Buildbucket for the build status
[23:52:39.335] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:52:39.335] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:98:0) after 1m0s
[23:53:39.515] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:98:0)
[23:53:39.517] Timer tick, asking Buildbucket for the build status
[23:53:39.743] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:53:39.743] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:99:0) after 1m0s
[23:54:39.813] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:99:0)
[23:54:39.813] Timer tick, asking Buildbucket for the build status
[23:54:39.965] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:54:39.965] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:100:0) after 1m0s
[23:55:39.974] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:100:0)
[23:55:39.974] Timer tick, asking Buildbucket for the build status
[23:55:40.345] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:55:40.345] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:101:0) after 1m0s
[23:56:40.390] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:101:0)
[23:56:40.390] Timer tick, asking Buildbucket for the build status
[23:56:40.613] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:56:40.613] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:102:0) after 1m0s
[23:57:40.642] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:102:0)
[23:57:40.642] Timer tick, asking Buildbucket for the build status
[23:57:41.770] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:57:41.770] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:103:0) after 1m0s
[23:58:41.792] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:103:0)
[23:58:41.792] Timer tick, asking Buildbucket for the build status
[23:58:42.449] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:58:42.449] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:104:0) after 1m0s
[23:59:42.547] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:104:0)
[23:59:42.547] Timer tick, asking Buildbucket for the build status
[23:59:43.919] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:59:43.919] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:105:0) after 1m0s
[00:00:44.059] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:105:0)
[00:00:44.059] Timer tick, asking Buildbucket for the build status
[00:00:44.305] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:00:44.305] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:106:0) after 1m0s
[00:01:44.401] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:106:0)
[00:01:44.401] Timer tick, asking Buildbucket for the build status
[00:01:44.731] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:01:44.731] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:107:0) after 1m0s
[00:02:44.869] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:107:0)
[00:02:44.869] Timer tick, asking Buildbucket for the build status
[00:02:45.155] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:02:45.155] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:108:0) after 1m0s
[00:03:45.211] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:108:0)
[00:03:45.211] Timer tick, asking Buildbucket for the build status
[00:03:47.285] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:03:47.285] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:109:0) after 1m0s
[00:04:47.389] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:109:0)
[00:04:47.389] Timer tick, asking Buildbucket for the build status
[00:04:49.561] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:04:49.561] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:110:0) after 1m0s
[00:05:49.620] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:110:0)
[00:05:49.620] Timer tick, asking Buildbucket for the build status
[00:05:50.368] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:05:50.368] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:111:0) after 1m0s
[00:06:50.553] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:111:0)
[00:06:50.553] Timer tick, asking Buildbucket for the build status
[00:06:51.183] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:06:51.183] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:112:0) after 1m0s
[00:07:51.281] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:112:0)
[00:07:51.281] Timer tick, asking Buildbucket for the build status
[00:07:51.669] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:07:51.669] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:113:0) after 1m0s
[00:08:51.681] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:113:0)
[00:08:51.681] Timer tick, asking Buildbucket for the build status
[00:08:52.161] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:08:52.161] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:114:0) after 1m0s
[00:09:52.181] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:114:0)
[00:09:52.181] Timer tick, asking Buildbucket for the build status
[00:09:53.017] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:09:53.017] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:115:0) after 1m0s
[00:10:53.073] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:115:0)
[00:10:53.073] Timer tick, asking Buildbucket for the build status
[00:10:53.694] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:10:53.694] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:116:0) after 1m0s
[00:11:53.841] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:116:0)
[00:11:53.841] Timer tick, asking Buildbucket for the build status
[00:11:54.077] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:11:54.077] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:117:0) after 1m0s
[00:12:54.105] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:117:0)
[00:12:54.105] Timer tick, asking Buildbucket for the build status
[00:12:56.084] Build 8891612443664218112: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:12:56.085] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9057042507203298784:118:0) after 1m0s
[00:12:56.450] Received PubSub notification, asking Buildbucket for the build status
[00:12:56.634] Build 8891612443664218112: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[00:12:56.634] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1578701575525033",
"created_by": "project:chromium",
"created_ts": "1578694603247544",
"id": "8891612443664218112",
"parameters_json": "{\"builder_name\": \"Deterministic Linux\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"011363481ff9ae207864793b7e5b1fad47d31112\"}}",
"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-8-112-bf60\", \"branch\": \"refs/heads/master\", \"buildername\": \"Deterministic Linux\", \"buildnumber\": 26419, \"got_angle_revision\": \"c792a6bacf68778aa38a1a5850f1fdca6f117e41\", \"got_dawn_revision\": \"5fc2c82c11e078928e6a0f9c447b69fe208815f8\", \"got_nacl_revision\": \"3651f6c52037c96e034cc422746768d59182bff3\", \"got_revision\": \"011363481ff9ae207864793b7e5b1fad47d31112\", \"got_revision_cp\": \"refs/heads/master@{#730315}\", \"got_swarming_client_revision\": \"885b3febcc170a60f25795304e60927b77d1e92d\", \"got_swiftshader_revision\": \"df913b9112621bbb44e14575654ea9139e5bd624\", \"got_v8_revision\": \"7006065f20dd6ee20961e5b7b72be70e431a8b83\", \"got_v8_revision_cp\": \"refs/heads/8.1.152@{#1}\", \"got_webrtc_revision\": \"b42aeaa3fb21d78e59c47d2a9916acb380494496\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#30212}\", \"mastername\": \"chromium.linux\", \"path_config\": \"generic\", \"recipe\": \"swarming/deterministic_build\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"011363481ff9ae207864793b7e5b1fad47d31112\"}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_78902ab2d70d1593a97658cf8910c0e117cf7950e257117b8c551c6fe1cfb403_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"8\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gpu\": [\"none\"], \"id\": [\"luci-chromium-ci-xenial-us-central1-b-8-112-bf60\"], \"image\": [\"chrome-xenial-19121500-b03549ec744\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"n1-standard-8\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-16.04\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.12\"], \"server_version\": [\"4752-73c7603\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1578694628338426",
"status": "COMPLETED",
"status_changed_ts": "1578701575977780",
"tags": [
"build_address:luci.chromium.ci/Deterministic Linux/26419",
"builder:Deterministic Linux",
"buildset:commit/git/011363481ff9ae207864793b7e5b1fad47d31112",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/011363481ff9ae207864793b7e5b1fad47d31112",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9057042507203298784",
"scheduler_job_id:chromium/Deterministic Linux",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8891612443664218112/+/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:49aa59d747b54b10",
"user_agent:luci-scheduler"
],
"updated_ts": "1578701576017581",
"url": "https://ci.chromium.org/b/8891612443664218112",
"utcnow_ts": "1578701576613201"
}
}
[00:12:56.634] Invocation finished in 1h56m16.146364529s with status SUCCEEDED