[19:23:38.550] New invocation is queued and will start shortly
[19:23:39.651] Starting the invocation (attempt 1)
[19:23:39.693] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[19:23:39.693] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[19:23:39.693] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9025888037028266192",
"parameters_json": "{\"builder_name\":\"Linux Builder (dbg)\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"526e51a138ac6f7516b9fb3f8d16f5143524309f\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:Linux Builder (dbg)",
"scheduler_invocation_id:9025888037028266192",
"scheduler_job_id:chromium/Linux Builder (dbg)",
"user_agent:luci-scheduler",
"buildset:commit/git/526e51a138ac6f7516b9fb3f8d16f5143524309f",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/526e51a138ac6f7516b9fb3f8d16f5143524309f",
"gitiles_ref:refs/heads/master"
]
}
[19:23:40.656] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1608405819793872",
"id": "8860457975062513280",
"parameters_json": "{\"builder_name\": \"Linux Builder (dbg)\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"526e51a138ac6f7516b9fb3f8d16f5143524309f\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1608405820556685",
"tags": [
"build_address:luci.chromium.ci/Linux Builder (dbg)/178830",
"builder:Linux Builder (dbg)",
"buildset:commit/git/526e51a138ac6f7516b9fb3f8d16f5143524309f",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/526e51a138ac6f7516b9fb3f8d16f5143524309f",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9025888037028266192",
"scheduler_job_id:chromium/Linux Builder (dbg)",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8860457975062513280/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:recipe_name:chromium",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:",
"user_agent:luci-scheduler"
],
"updated_ts": "1608405820556781",
"url": "https://ci.chromium.org/b/8860457975062513280",
"utcnow_ts": "1608405820650129"
}
}
[19:23:40.656] Task URL: https://ci.chromium.org/b/8860457975062513280
[19:23:40.656] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:2:0) after 1m0s
[19:24:41.040] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:2:0)
[19:24:41.040] Timer tick, asking Buildbucket for the build status
[19:24:41.134] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:24:41.134] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:3:0) after 1m0s
[19:25:41.330] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:3:0)
[19:25:41.330] Timer tick, asking Buildbucket for the build status
[19:25:41.393] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:25:41.393] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:4:0) after 1m0s
[19:26:41.555] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:4:0)
[19:26:41.555] Timer tick, asking Buildbucket for the build status
[19:26:41.610] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:26:41.610] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:5:0) after 1m0s
[19:27:41.715] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:5:0)
[19:27:41.715] Timer tick, asking Buildbucket for the build status
[19:27:41.849] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:27:41.849] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:6:0) after 1m0s
[19:28:41.956] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:6:0)
[19:28:41.956] Timer tick, asking Buildbucket for the build status
[19:28:42.052] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:28:42.052] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:7:0) after 1m0s
[19:29:42.202] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:7:0)
[19:29:42.202] Timer tick, asking Buildbucket for the build status
[19:29:42.386] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:29:42.386] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:8:0) after 1m0s
[19:30:42.729] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:8:0)
[19:30:42.729] Timer tick, asking Buildbucket for the build status
[19:30:42.807] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:30:42.807] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:9:0) after 1m0s
[19:31:43.276] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:9:0)
[19:31:43.276] Timer tick, asking Buildbucket for the build status
[19:31:43.344] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:31:43.344] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:10:0) after 1m0s
[19:32:43.480] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:10:0)
[19:32:43.480] Timer tick, asking Buildbucket for the build status
[19:32:43.550] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:32:43.550] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:11:0) after 1m0s
[19:33:43.864] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:11:0)
[19:33:43.864] Timer tick, asking Buildbucket for the build status
[19:33:44.334] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:33:44.334] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:12:0) after 1m0s
[19:34:44.499] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:12:0)
[19:34:44.499] Timer tick, asking Buildbucket for the build status
[19:34:44.894] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:34:44.894] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:13:0) after 1m0s
[19:35:45.021] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:13:0)
[19:35:45.021] Timer tick, asking Buildbucket for the build status
[19:35:45.092] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:35:45.092] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:14:0) after 1m0s
[19:36:45.159] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:14:0)
[19:36:45.159] Timer tick, asking Buildbucket for the build status
[19:36:45.418] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:36:45.418] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:15:0) after 1m0s
[19:37:45.428] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:15:0)
[19:37:45.428] Timer tick, asking Buildbucket for the build status
[19:37:45.515] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:37:45.515] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:16:0) after 1m0s
[19:38:45.711] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:16:0)
[19:38:45.711] Timer tick, asking Buildbucket for the build status
[19:38:45.789] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:38:45.789] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:17:0) after 1m0s
[19:39:45.907] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:17:0)
[19:39:45.907] Timer tick, asking Buildbucket for the build status
[19:39:45.989] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:39:45.989] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:18:0) after 1m0s
[19:40:46.107] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:18:0)
[19:40:46.107] Timer tick, asking Buildbucket for the build status
[19:40:46.182] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:40:46.182] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:19:0) after 1m0s
[19:41:46.319] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:19:0)
[19:41:46.319] Timer tick, asking Buildbucket for the build status
[19:41:46.382] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:41:46.382] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:20:0) after 1m0s
[19:42:46.500] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:20:0)
[19:42:46.500] Timer tick, asking Buildbucket for the build status
[19:42:46.725] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:42:46.725] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:21:0) after 1m0s
[19:43:46.866] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:21:0)
[19:43:46.866] Timer tick, asking Buildbucket for the build status
[19:43:47.006] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:43:47.006] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:22:0) after 1m0s
[19:44:47.273] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:22:0)
[19:44:47.273] Timer tick, asking Buildbucket for the build status
[19:44:47.332] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:44:47.332] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:23:0) after 1m0s
[19:45:47.355] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:23:0)
[19:45:47.355] Timer tick, asking Buildbucket for the build status
[19:45:47.467] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:45:47.467] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:24:0) after 1m0s
[19:46:47.522] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:24:0)
[19:46:47.522] Timer tick, asking Buildbucket for the build status
[19:46:47.591] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:46:47.591] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:25:0) after 1m0s
[19:47:47.613] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:25:0)
[19:47:47.613] Timer tick, asking Buildbucket for the build status
[19:47:47.672] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:47:47.672] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:26:0) after 1m0s
[19:48:47.744] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:26:0)
[19:48:47.744] Timer tick, asking Buildbucket for the build status
[19:48:47.956] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:48:47.956] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:27:0) after 1m0s
[19:49:48.001] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:27:0)
[19:49:48.001] Timer tick, asking Buildbucket for the build status
[19:49:48.067] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:49:48.067] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:28:0) after 1m0s
[19:50:48.235] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:28:0)
[19:50:48.235] Timer tick, asking Buildbucket for the build status
[19:50:48.354] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:50:48.354] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:29:0) after 1m0s
[19:51:48.438] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:29:0)
[19:51:48.438] Timer tick, asking Buildbucket for the build status
[19:51:48.508] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:51:48.508] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:30:0) after 1m0s
[19:52:48.529] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:30:0)
[19:52:48.529] Timer tick, asking Buildbucket for the build status
[19:52:48.603] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:52:48.603] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:31:0) after 1m0s
[19:53:48.705] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:31:0)
[19:53:48.705] Timer tick, asking Buildbucket for the build status
[19:53:48.785] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:53:48.785] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:32:0) after 1m0s
[19:54:48.814] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:32:0)
[19:54:48.814] Timer tick, asking Buildbucket for the build status
[19:54:48.919] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:54:48.919] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:33:0) after 1m0s
[19:55:48.916] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:33:0)
[19:55:48.916] Timer tick, asking Buildbucket for the build status
[19:55:49.002] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:55:49.003] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:34:0) after 1m0s
[19:56:49.024] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:34:0)
[19:56:49.024] Timer tick, asking Buildbucket for the build status
[19:56:49.090] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:56:49.090] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:35:0) after 1m0s
[19:57:49.114] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:35:0)
[19:57:49.114] Timer tick, asking Buildbucket for the build status
[19:57:49.175] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:57:49.175] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:36:0) after 1m0s
[19:58:49.194] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:36:0)
[19:58:49.194] Timer tick, asking Buildbucket for the build status
[19:58:49.580] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:58:49.580] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:37:0) after 1m0s
[19:59:49.634] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:37:0)
[19:59:49.634] Timer tick, asking Buildbucket for the build status
[19:59:49.703] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:59:49.703] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:38:0) after 1m0s
[20:00:49.731] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:38:0)
[20:00:49.731] Timer tick, asking Buildbucket for the build status
[20:00:49.797] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[20:00:49.797] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:39:0) after 1m0s
[20:01:49.807] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:39:0)
[20:01:49.807] Timer tick, asking Buildbucket for the build status
[20:01:50.013] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[20:01:50.013] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:40:0) after 1m0s
[20:02:50.022] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:40:0)
[20:02:50.022] Timer tick, asking Buildbucket for the build status
[20:02:50.103] Build 8860457975062513280: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[20:02:50.103] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:41:0) after 1m0s
[20:03:49.771] Received PubSub notification, asking Buildbucket for the build status
[20:03:49.830] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:03:50.136] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:41:0)
[20:03:50.136] Timer tick, asking Buildbucket for the build status
[20:03:50.191] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:03:50.191] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:43:0) after 1m0s
[20:04:50.207] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:43:0)
[20:04:50.207] Timer tick, asking Buildbucket for the build status
[20:04:50.651] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:04:50.651] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:44:0) after 1m0s
[20:05:50.710] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:44:0)
[20:05:50.710] Timer tick, asking Buildbucket for the build status
[20:05:50.789] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:05:50.789] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:45:0) after 1m0s
[20:06:50.776] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:45:0)
[20:06:50.776] Timer tick, asking Buildbucket for the build status
[20:06:50.823] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:06:50.823] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:46:0) after 1m0s
[20:07:50.845] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:46:0)
[20:07:50.845] Timer tick, asking Buildbucket for the build status
[20:07:50.951] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:07:50.951] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:47:0) after 1m0s
[20:08:51.012] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:47:0)
[20:08:51.012] Timer tick, asking Buildbucket for the build status
[20:08:51.121] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:08:51.121] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:48:0) after 1m0s
[20:09:51.149] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:48:0)
[20:09:51.149] Timer tick, asking Buildbucket for the build status
[20:09:51.236] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:09:51.236] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:49:0) after 1m0s
[20:10:51.285] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:49:0)
[20:10:51.285] Timer tick, asking Buildbucket for the build status
[20:10:51.362] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:10:51.362] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:50:0) after 1m0s
[20:11:51.384] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:50:0)
[20:11:51.384] Timer tick, asking Buildbucket for the build status
[20:11:51.487] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:11:51.487] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:51:0) after 1m0s
[20:12:51.496] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:51:0)
[20:12:51.496] Timer tick, asking Buildbucket for the build status
[20:12:51.540] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:12:51.540] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:52:0) after 1m0s
[20:13:51.566] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:52:0)
[20:13:51.566] Timer tick, asking Buildbucket for the build status
[20:13:51.786] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:13:51.786] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:53:0) after 1m0s
[20:14:51.842] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:53:0)
[20:14:51.842] Timer tick, asking Buildbucket for the build status
[20:14:51.926] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:14:51.926] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:54:0) after 1m0s
[20:15:51.958] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:54:0)
[20:15:51.958] Timer tick, asking Buildbucket for the build status
[20:15:52.023] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:15:52.023] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:55:0) after 1m0s
[20:16:52.075] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:55:0)
[20:16:52.075] Timer tick, asking Buildbucket for the build status
[20:16:52.129] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:16:52.129] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:56:0) after 1m0s
[20:17:52.180] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:56:0)
[20:17:52.180] Timer tick, asking Buildbucket for the build status
[20:17:52.235] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:17:52.235] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:57:0) after 1m0s
[20:18:52.272] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:57:0)
[20:18:52.272] Timer tick, asking Buildbucket for the build status
[20:18:52.383] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:18:52.383] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:58:0) after 1m0s
[20:19:52.504] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:58:0)
[20:19:52.504] Timer tick, asking Buildbucket for the build status
[20:19:52.545] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:19:52.545] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:59:0) after 1m0s
[20:20:52.579] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:59:0)
[20:20:52.579] Timer tick, asking Buildbucket for the build status
[20:20:52.633] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:20:52.633] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:60:0) after 1m0s
[20:21:52.675] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:60:0)
[20:21:52.675] Timer tick, asking Buildbucket for the build status
[20:21:52.746] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:21:52.746] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:61:0) after 1m0s
[20:22:52.784] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:61:0)
[20:22:52.784] Timer tick, asking Buildbucket for the build status
[20:22:53.112] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:22:53.112] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:62:0) after 1m0s
[20:23:53.213] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:62:0)
[20:23:53.213] Timer tick, asking Buildbucket for the build status
[20:23:53.383] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:23:53.383] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:63:0) after 1m0s
[20:24:53.405] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:63:0)
[20:24:53.405] Timer tick, asking Buildbucket for the build status
[20:24:53.604] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:24:53.604] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:64:0) after 1m0s
[20:25:53.609] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:64:0)
[20:25:53.609] Timer tick, asking Buildbucket for the build status
[20:25:53.871] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:25:53.871] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:65:0) after 1m0s
[20:26:53.911] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:65:0)
[20:26:53.911] Timer tick, asking Buildbucket for the build status
[20:26:53.965] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:26:53.965] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:66:0) after 1m0s
[20:27:53.996] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:66:0)
[20:27:53.996] Timer tick, asking Buildbucket for the build status
[20:27:54.044] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:27:54.044] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:67:0) after 1m0s
[20:28:54.108] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:67:0)
[20:28:54.108] Timer tick, asking Buildbucket for the build status
[20:28:54.296] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:28:54.296] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:68:0) after 1m0s
[20:29:54.290] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:68:0)
[20:29:54.290] Timer tick, asking Buildbucket for the build status
[20:29:54.591] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:29:54.591] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:69:0) after 1m0s
[20:30:54.648] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:69:0)
[20:30:54.648] Timer tick, asking Buildbucket for the build status
[20:30:54.701] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:30:54.701] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:70:0) after 1m0s
[20:31:54.686] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:70:0)
[20:31:54.686] Timer tick, asking Buildbucket for the build status
[20:31:54.752] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:31:54.752] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:71:0) after 1m0s
[20:32:54.776] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:71:0)
[20:32:54.776] Timer tick, asking Buildbucket for the build status
[20:32:54.937] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:32:54.937] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:72:0) after 1m0s
[20:33:54.987] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:72:0)
[20:33:54.987] Timer tick, asking Buildbucket for the build status
[20:33:55.072] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:33:55.072] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:73:0) after 1m0s
[20:34:55.122] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:73:0)
[20:34:55.122] Timer tick, asking Buildbucket for the build status
[20:34:55.210] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:34:55.210] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:74:0) after 1m0s
[20:35:55.265] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:74:0)
[20:35:55.265] Timer tick, asking Buildbucket for the build status
[20:35:55.446] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:35:55.446] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:75:0) after 1m0s
[20:36:55.500] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:75:0)
[20:36:55.500] Timer tick, asking Buildbucket for the build status
[20:36:55.568] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:36:55.568] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:76:0) after 1m0s
[20:37:55.588] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:76:0)
[20:37:55.588] Timer tick, asking Buildbucket for the build status
[20:37:55.745] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:37:55.745] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:77:0) after 1m0s
[20:38:55.769] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:77:0)
[20:38:55.769] Timer tick, asking Buildbucket for the build status
[20:38:55.902] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:38:55.902] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:78:0) after 1m0s
[20:39:55.962] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:78:0)
[20:39:55.962] Timer tick, asking Buildbucket for the build status
[20:39:56.022] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:39:56.022] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:79:0) after 1m0s
[20:40:56.012] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:79:0)
[20:40:56.012] Timer tick, asking Buildbucket for the build status
[20:40:56.279] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:40:56.280] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:80:0) after 1m0s
[20:41:56.395] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:80:0)
[20:41:56.396] Timer tick, asking Buildbucket for the build status
[20:41:56.446] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:41:56.446] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:81:0) after 1m0s
[20:42:56.551] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:81:0)
[20:42:56.551] Timer tick, asking Buildbucket for the build status
[20:42:56.668] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:42:56.668] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:82:0) after 1m0s
[20:43:56.738] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:82:0)
[20:43:56.738] Timer tick, asking Buildbucket for the build status
[20:43:57.172] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:43:57.173] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:83:0) after 1m0s
[20:44:57.381] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:83:0)
[20:44:57.381] Timer tick, asking Buildbucket for the build status
[20:44:57.434] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:44:57.434] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:84:0) after 1m0s
[20:45:57.716] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:84:0)
[20:45:57.716] Timer tick, asking Buildbucket for the build status
[20:45:57.776] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:45:57.776] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:85:0) after 1m0s
[20:46:58.027] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:85:0)
[20:46:58.027] Timer tick, asking Buildbucket for the build status
[20:46:58.082] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:46:58.082] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:86:0) after 1m0s
[20:47:58.136] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:86:0)
[20:47:58.136] Timer tick, asking Buildbucket for the build status
[20:47:58.279] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:47:58.279] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:87:0) after 1m0s
[20:48:58.324] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:87:0)
[20:48:58.324] Timer tick, asking Buildbucket for the build status
[20:48:58.413] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:48:58.413] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:88:0) after 1m0s
[20:49:58.456] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:88:0)
[20:49:58.456] Timer tick, asking Buildbucket for the build status
[20:49:58.519] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:49:58.519] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:89:0) after 1m0s
[20:50:58.919] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:89:0)
[20:50:58.919] Timer tick, asking Buildbucket for the build status
[20:50:58.987] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:50:58.987] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:90:0) after 1m0s
[20:51:59.161] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:90:0)
[20:51:59.161] Timer tick, asking Buildbucket for the build status
[20:51:59.349] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:51:59.349] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:91:0) after 1m0s
[20:52:59.480] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:91:0)
[20:52:59.480] Timer tick, asking Buildbucket for the build status
[20:52:59.601] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:52:59.601] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:92:0) after 1m0s
[20:54:00.800] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:92:0)
[20:54:00.800] Timer tick, asking Buildbucket for the build status
[20:54:00.905] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:54:00.905] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:93:0) after 1m0s
[20:55:01.214] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:93:0)
[20:55:01.214] Timer tick, asking Buildbucket for the build status
[20:55:01.412] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:55:01.412] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:94:0) after 1m0s
[20:56:01.604] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:94:0)
[20:56:01.604] Timer tick, asking Buildbucket for the build status
[20:56:01.906] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:56:01.906] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:95:0) after 1m0s
[20:57:02.013] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:95:0)
[20:57:02.013] Timer tick, asking Buildbucket for the build status
[20:57:02.223] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:57:02.223] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:96:0) after 1m0s
[20:58:02.284] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:96:0)
[20:58:02.284] Timer tick, asking Buildbucket for the build status
[20:58:02.334] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:58:02.334] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:97:0) after 1m0s
[20:59:02.506] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:97:0)
[20:59:02.506] Timer tick, asking Buildbucket for the build status
[20:59:02.617] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:59:02.617] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:98:0) after 1m0s
[21:00:02.675] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:98:0)
[21:00:02.675] Timer tick, asking Buildbucket for the build status
[21:00:02.745] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:00:02.745] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:99:0) after 1m0s
[21:01:02.823] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:99:0)
[21:01:02.823] Timer tick, asking Buildbucket for the build status
[21:01:02.887] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:01:02.887] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:100:0) after 1m0s
[21:02:03.142] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:100:0)
[21:02:03.142] Timer tick, asking Buildbucket for the build status
[21:02:03.620] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:02:03.620] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:101:0) after 1m0s
[21:03:03.648] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:101:0)
[21:03:03.648] Timer tick, asking Buildbucket for the build status
[21:03:03.822] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:03:03.822] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:102:0) after 1m0s
[21:04:03.845] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:102:0)
[21:04:03.845] Timer tick, asking Buildbucket for the build status
[21:04:03.942] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:04:03.942] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:103:0) after 1m0s
[21:05:03.985] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:103:0)
[21:05:03.985] Timer tick, asking Buildbucket for the build status
[21:05:04.075] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:05:04.075] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:104:0) after 1m0s
[21:06:04.255] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:104:0)
[21:06:04.255] Timer tick, asking Buildbucket for the build status
[21:06:04.322] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:06:04.322] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:105:0) after 1m0s
[21:07:04.682] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:105:0)
[21:07:04.682] Timer tick, asking Buildbucket for the build status
[21:07:04.785] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:07:04.785] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:106:0) after 1m0s
[21:08:04.809] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:106:0)
[21:08:04.809] Timer tick, asking Buildbucket for the build status
[21:08:04.918] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:08:04.919] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:107:0) after 1m0s
[21:09:04.975] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:107:0)
[21:09:04.975] Timer tick, asking Buildbucket for the build status
[21:09:05.262] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:09:05.262] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:108:0) after 1m0s
[21:10:05.399] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:108:0)
[21:10:05.399] Timer tick, asking Buildbucket for the build status
[21:10:05.489] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:10:05.489] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:109:0) after 1m0s
[21:11:05.570] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:109:0)
[21:11:05.570] Timer tick, asking Buildbucket for the build status
[21:11:05.724] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:11:05.724] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:110:0) after 1m0s
[21:12:05.777] Handling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:110:0)
[21:12:05.777] Timer tick, asking Buildbucket for the build status
[21:12:05.849] Build 8860457975062513280: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:12:05.849] Scheduling timer "check-buildbucket-build-status" (chromium/Linux Builder (dbg):9025888037028266192:111:0) after 1m0s
[21:12:11.666] Received PubSub notification, asking Buildbucket for the build status
[21:12:11.801] Build 8860457975062513280: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[21:12:11.801] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1608412330811770",
"created_by": "project:chromium",
"created_ts": "1608405819793872",
"id": "8860457975062513280",
"parameters_json": "{\"builder_name\": \"Linux Builder (dbg)\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"526e51a138ac6f7516b9fb3f8d16f5143524309f\"}}",
"project": "chromium",
"result": "SUCCESS",
"result_details_json": "{\"properties\": {\"$build/goma\": {\"enable_ats\": true, \"jobs\": 500.0, \"rpc_extra_params\": \"?prod\", \"server_host\": \"goma.chromium.org\", \"use_luci_auth\": true}, \"$recipe_engine/isolated\": {\"server\": \"https://isolateserver.appspot.com\"}, \"$recipe_engine/milo/blamelist_pins\": [{\"host\": \"chromium.googlesource.com\", \"id\": \"526e51a138ac6f7516b9fb3f8d16f5143524309f\", \"project\": \"chromium/src\"}], \"$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-5-xmcw\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.linux\", \"buildername\": \"Linux Builder (dbg)\", \"buildnumber\": 178830, \"got_angle_revision\": \"ed9213bca0643edb65b7d39a938210419398a1b3\", \"got_dawn_revision\": \"5d4fd88a7403aa255d49919d011af54c691b344a\", \"got_nacl_revision\": \"299d4780ec86121ff2a5368ed9435ade0e356e5e\", \"got_revision\": \"526e51a138ac6f7516b9fb3f8d16f5143524309f\", \"got_revision_cp\": \"refs/heads/master@{#838529}\", \"got_swarming_client_revision\": \"1a072711d4388c62e02480fabc26c68c24494be9\", \"got_swiftshader_revision\": \"1cc5b3357d2ff3c81ef7ec0b07a6660796bde5cd\", \"got_v8_revision\": \"c4b600873d9668aeeb4f28e20f86d82b5c75379c\", \"got_v8_revision_cp\": \"refs/heads/8.9.177@{#1}\", \"got_webrtc_revision\": \"d7f750f7be4b2f61018d3cb55a995d09daa226e6\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#32862}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"mirrored_builders\": [\"tryserver.chromium.linux:linux-clang-tidy-dbg\", \"tryserver.chromium.linux:linux_chromium_dbg_ng\", \"tryserver.chromium.linux:linux_chromium_compile_dbg_ng\"], \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"526e51a138ac6f7516b9fb3f8d16f5143524309f\", \"swarm_hashes_refs/heads/master(at){#838529}_without_patch\": {\"absl_hardening_tests\": \"8f375d384e5b8a2ebdecc24bca0624147a11a2f1\", \"accessibility_unittests\": \"36a3c864e08615de3d88baaebf735d1eef6badff\", \"angle_unittests\": \"6291cbe995b57c402b427dcd62f8f6abc7b60ab2\", \"app_shell_unittests\": \"ac0a1bfb075006482eed99e1f774dc165a97e553\", \"aura_unittests\": \"ffa97cdd976071b6b33f65fef15c297d74d653b5\", \"base_unittests\": \"d707ed28b15b976451dca9fc89e14bff4ab070bc\", \"base_util_unittests\": \"84b03bad7f08af7e4c9c18e185422390f121e9d4\", \"blink_common_unittests\": \"3fd37ecdf6dc47e32c6d129064ce504c92c9a90a\", \"blink_fuzzer_unittests\": \"cdff362b13b8f5ec8bcaceac7b0b12631ba64884\", \"blink_heap_unittests\": \"ff27128c66751bbf860d837af32496a7cad09427\", \"blink_platform_unittests\": \"8675b785d48806d5b664282011f98d6ff0af4ad2\", \"blink_python_tests\": \"a850068bffdc4a670df6ad15aeda052beec9a023\", \"blink_unittests\": \"3c1c97a032d1fc8483c656cd1440a49c3998f12f\", \"blink_web_tests\": \"d60d77e856817dc371d360591f33a7d4e489d750\", \"boringssl_crypto_tests\": \"339c2652771d7b3e164a30240cc807aad06fc5f2\", \"boringssl_ssl_tests\": \"4125b55d8cb2aefef23667153037cfe9fe874c0e\", \"browser_tests\": \"e8b0854725c6fb2aef1401a84d0bc9dc1b128583\", \"capture_unittests\": \"23b4aa60d41525be6632e8accc633611c6a1b467\", \"cast_unittests\": \"401fc1e8214ac0c5c7a4cee69c5e8e7c6fa3f597\", \"cc_unittests\": \"644fe35a7b0c44d103169e57e1ffe4fc385718c0\", \"chrome_app_unittests\": \"edee73f9420d21422e4b6adf3367fb85295a153a\", \"chromedriver_unittests\": \"e1c8dde0ae839945a964daac7605cb235399dedd\", \"components_browsertests\": \"c03ba1f8ad77b85d5b79a23814a413a4d3f72d2b\", \"components_unittests\": \"05c0bf0fe02691089a1ff89b6a300e190c927978\", \"compositor_unittests\": \"9ef2a564cf4f9905bf9c3ff02801d73e8d1c50e0\", \"content_browsertests\": \"eb1df78539e4219ba05b4cc77c159d47aac0c928\", \"content_shell_crash_test\": \"e4da2c456087e74b4bfe44a8870b006c952791da\", \"content_unittests\": \"0a0058264767fb401b8cba76a8c2ce2b4472842e\", \"crashpad_tests\": \"49f3237b435657bd0a41708c953bbb6e2282e049\", \"cronet_tests\": \"b3083194d91cd5974dbe4e5a061d21a307589f97\", \"cronet_unittests\": \"4a06513acb5948251e6c6389f9c8475572522816\", \"crypto_unittests\": \"b4ea65d67dbc4046191211f280ea3161f64e3024\", \"dbus_unittests\": \"97b1705f3871e03b4dd6c1be2b4fd003b75ee19e\", \"device_unittests\": \"615e05561cc1157fd5d0f0d629ed766d029e9ae5\", \"display_unittests\": \"1c1488fcfa9585b82ac28da69227dda2355b6d2e\", \"events_unittests\": \"e812e1d4131faf79bb7eccfe3f628c3e60697bf8\", \"extension_docserver_python_unittests\": \"d2c9142966a0b67f7aec9c3117242150c75cd902\", \"extensions_browsertests\": \"a903f7ca0fae399feee46a1a22225e2409e11d57\", \"extensions_unittests\": \"2ffc8d7ded0a151462d04ea732258926ee32497f\", \"filesystem_service_unittests\": \"0b40852fd3775977720bbc5f6e20cd46754b1bb3\", \"flatbuffers_unittests\": \"d051d66da1ab229778a7e9a8f6ace686eaf5e782\", \"gcm_unit_tests\": \"e90fe9b5a95b5ec75bcdab60d4bb303893dc8073\", \"gfx_unittests\": \"d80a33fcc75e2896c72da7413bc49df4d33995b3\", \"gin_unittests\": \"46168b48775b31b3cc81000691150e3347ef3b55\", \"google_apis_unittests\": \"c6122452f4019d56071922195c064c39bde6e8af\", \"gpu_unittests\": \"dba44cd938b126a9050d94a737f9a3ba870f7c43\", \"grit_python_unittests\": \"275c161e38b800af0a18bf8ee2ae20e83dfa4ea2\", \"gwp_asan_unittests\": \"85a4409656e25530c6e025787387b24b69465007\", \"headless_browsertests\": \"49503accab70510a99889325d63f11abbaffbbcf\", \"headless_unittests\": \"e347ec5258921497aafe6219e3ecfc0e838f7a2c\", \"interactive_ui_tests\": \"96ad0a17ff339d5daeef973aecd040cb48da2c5c\", \"ipc_tests\": \"2b1624151520172c529bfbe9fb113c1d5013ff29\", \"jingle_unittests\": \"452872d6f92a9bdba5c40f6fcd6300f60982daca\", \"latency_unittests\": \"1f6b809923b319be1fb8e042ad9330f1ee73733b\", \"libjingle_xmpp_unittests\": \"892a002b30cf1f12b3008fdc93270d3bedfc9e06\", \"liburlpattern_unittests\": \"2474b765488b21a51c6bda6602ca1fc506c1de64\", \"media_blink_unittests\": \"90d252dfa1977479083d6dcbbea5005f3fabd654\", \"media_unittests\": \"56d750464c9a28760c02d2cdb19a628c1d0bf301\", \"message_center_unittests\": \"d36644a2034e67860103e377241f1758c9b3e71f\", \"metrics_python_tests\": \"9a057f240d8e448aea1f99ca8cd2be4817085334\", \"midi_unittests\": \"57a890852d18c64577e69240879eddae32ad007f\", \"mojo_core_unittests\": \"abb7d61cbf24e8c91d09191c5de588526a852443\", \"mojo_unittests\": \"b94a9515601f87d291537e9d61690e18d334b4fa\", \"nacl_helper_nonsfi_unittests\": \"504b27c5496dae8f718aa86efc3942da9cd9266e\", \"nacl_loader_unittests\": \"2243b0a7e49f9fb62c68f54abf452d42f262ad71\", \"native_theme_unittests\": \"095c58f890dd164668aec7880c983a4f0a310d28\", \"net_unittests\": \"ed63b978e2b48113613bbefe2bcd473d2b071a8e\", \"openscreen_unittests\": \"51b2093a8594fdfbfa9cad2f80d22813738403a4\", \"pdf_unittests\": \"9c1d8937ad83bfb71be75a0b34c97ac15afd9b92\", \"perfetto_unittests\": \"2b4794f2711a3c606bb1b5db4b17b4c5bc51e90d\", \"ppapi_unittests\": \"1cc897984e64fc87d976f0678bd1bcfa7fe2bd1d\", \"printing_unittests\": \"32c3ec7dadf5943c19bda8b982595d2bd9f39117\", \"remoting_unittests\": \"3b208fc67c1d7f481ee42ee1f2315cdf9960c571\", \"sandbox_linux_unittests\": \"7b6c06a037257977d5ce0d7d5edadaef9eb97a47\", \"service_manager_unittests\": \"bf338b4006bffdca8e3ed213a48673ffaa0bc226\", \"services_unittests\": \"5d869c305da1b205627e05c0fa045291b18b57a8\", \"shell_dialogs_unittests\": \"31d2edbbd8ffb099ddfa8ffe204c32b1f403467a\", \"skia_unittests\": \"8a160b4b94a76a09827149d11673f1ee5bf9e7a1\", \"snapshot_unittests\": \"5312d10abe01b33669cdd589fa3eca8cf33a6281\", \"sql_unittests\": \"29d5e2732b97881338fedde8246ed0f24f84b4b7\", \"storage_unittests\": \"c9e994b5fb0cc2e7921272d1bf17cbfc76ea69e1\", \"sync_integration_tests\": \"e9bff364a6892dbc8934966de2d8fcfccaa3931a\", \"telemetry_gpu_unittests\": \"72e49f1d6f8f2162e1e79a624e9ce46fee20ad43\", \"telemetry_perf_unittests\": \"3092e4eff2a164c8d54e1a487730c25bacb21253\", \"telemetry_unittests\": \"073218da3dec90ad48e62141b0e067f1435e68ac\", \"traffic_annotation_auditor_unittests\": \"5fc96914b84f2ff7bb978b419faf57a1a1405c1b\", \"ui_base_unittests\": \"c5e92b53902da42777b5f12718f29dc3c831a433\", \"ui_touch_selection_unittests\": \"a688cc0e25664543eaa99c1b68a9bbe31eef3ae0\", \"unit_tests\": \"73cfc35273d572f1a7e69296e7fd5a0f30ab63d9\", \"url_unittests\": \"5b822a9d7fbf590f3099afe3a26445eb7a924efb\", \"views_perftests\": \"4e271ef72b33ad614d04f852ba7ea24cfd8594c0\", \"views_unittests\": \"913d23a43b33a78711d92bccd6923da8d6ca325e\", \"viz_unittests\": \"fc2316f07fbb3332b05e0e5b689c1b1091078b96\", \"vr_common_unittests\": \"9b13a36812cc84ce3dbab898c0f9629e309d0177\", \"vr_pixeltests\": \"a63d69319ee2b9fee3261b5e27a0d897fd44f741\", \"webdriver_wpt_tests\": \"7e47f2c616265211584076ffa02abcb0fa214795\", \"weblayer_browsertests\": \"d2fb2789ef9dcf4a6a4e6dedeff9076fbe349be0\", \"weblayer_unittests\": \"1bd68d95570b52a87db891627cbe5d95df0d0dbe\", \"wm_unittests\": \"2113f25a90408323819c5d0adc85a60ca0e84d20\", \"wtf_unittests\": \"55531b456c95a8aa2f065d15f627fd8caa344c84\", \"x11_unittests\": \"66680cbb5846464724070a4fc78f702eb7f9e0bf\", \"xr_browser_tests\": \"134e38b2f81c721966e7bd0e18632f03e668d11e\", \"zlib_unittests\": \"d7b4949fd0c0340e972b0ab41b48f91449fbaa72\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_0111b226b6a2e1a66cbbf5d93fde4367495bc99d98428795ba3e931083c57f27_v2\", \"builder_361cbaa79261c75a92fc63a8f8c6fc117764238b3277286fa51086e6da3301df_v2\", \"builder_db6a6033e460ced730b3940170fe4cf923f58c29fb56731f98470df5edf70e65_v2\", \"builder_fe5305c96c631c9bcc74a68d877d31a94a8d3c28663b28d2fadfc8f798de4ec0_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"8\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Haswell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"luci-chromium-ci-xenial-us-central1-b-8-5-xmcw\"], \"image\": [\"chrome-xenial-20121300-d43316a0aad\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"e2-standard-8\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-16\", \"Ubuntu-16.04\", \"Ubuntu-16.04.6\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.12\"], \"server_version\": [\"5657-0417a3f\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1608408228986767",
"status": "COMPLETED",
"status_changed_ts": "1608412331348286",
"tags": [
"build_address:luci.chromium.ci/Linux Builder (dbg)/178830",
"builder:Linux Builder (dbg)",
"buildset:commit/git/526e51a138ac6f7516b9fb3f8d16f5143524309f",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/526e51a138ac6f7516b9fb3f8d16f5143524309f",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9025888037028266192",
"scheduler_job_id:chromium/Linux Builder (dbg)",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8860457975062513280/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:os:Linux",
"swarming_tag:recipe_name:chromium",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:509546adaef8c910",
"user_agent:luci-scheduler"
],
"updated_ts": "1608412331363723",
"url": "https://ci.chromium.org/b/8860457975062513280",
"utcnow_ts": "1608412331790917"
}
}
[21:12:11.802] Invocation finished in 1h48m33.266991643s with status SUCCEEDED