[19:43:40.805] New invocation is queued and will start shortly
[19:43:41.884] Starting the invocation (attempt 1)
[19:43:41.920] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[19:43:41.922] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[19:43:41.922] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9019816779623173632",
"parameters_json": "{\"builder_name\":\"linux-chromeos-dbg\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"b0d235a2b8efc7d2a8241c24038cd5f57ae72e45\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:linux-chromeos-dbg",
"scheduler_invocation_id:9019816779623173632",
"scheduler_job_id:chromium/linux-chromeos-dbg",
"user_agent:luci-scheduler",
"buildset:commit/git/b0d235a2b8efc7d2a8241c24038cd5f57ae72e45",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/b0d235a2b8efc7d2a8241c24038cd5f57ae72e45",
"gitiles_ref:refs/heads/master"
]
}
[19:43:43.102] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1614195822019502",
"id": "8854386717689332480",
"parameters_json": "{\"builder_name\": \"linux-chromeos-dbg\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"b0d235a2b8efc7d2a8241c24038cd5f57ae72e45\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1614195822837311",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-dbg/22765",
"builder:linux-chromeos-dbg",
"buildset:commit/git/b0d235a2b8efc7d2a8241c24038cd5f57ae72e45",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/b0d235a2b8efc7d2a8241c24038cd5f57ae72e45",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9019816779623173632",
"scheduler_job_id:chromium/linux-chromeos-dbg",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8854386717689332480/+/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": "1614195822837439",
"url": "https://ci.chromium.org/b/8854386717689332480",
"utcnow_ts": "1614195823035729"
}
}
[19:43:43.102] Task URL: https://ci.chromium.org/b/8854386717689332480
[19:43:43.102] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:2:0) after 1m0s
[19:44:43.159] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:2:0)
[19:44:43.159] Timer tick, asking Buildbucket for the build status
[19:44:43.253] Build 8854386717689332480: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:44:43.253] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:3:0) after 1m0s
[19:45:43.306] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:3:0)
[19:45:43.306] Timer tick, asking Buildbucket for the build status
[19:45:43.464] Build 8854386717689332480: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:45:43.464] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:4:0) after 1m0s
[19:46:03.567] Received PubSub notification, asking Buildbucket for the build status
[19:46:03.647] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:46:43.463] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:4:0)
[19:46:43.463] Timer tick, asking Buildbucket for the build status
[19:46:43.683] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:46:43.683] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:6:0) after 1m0s
[19:47:43.725] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:6:0)
[19:47:43.725] Timer tick, asking Buildbucket for the build status
[19:47:43.803] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:47:43.803] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:7:0) after 1m0s
[19:48:43.823] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:7:0)
[19:48:43.823] Timer tick, asking Buildbucket for the build status
[19:48:44.279] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:48:44.279] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:8:0) after 1m0s
[19:49:44.326] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:8:0)
[19:49:44.326] Timer tick, asking Buildbucket for the build status
[19:49:44.397] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:49:44.397] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:9:0) after 1m0s
[19:50:44.447] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:9:0)
[19:50:44.447] Timer tick, asking Buildbucket for the build status
[19:50:45.121] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:50:45.121] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:10:0) after 1m0s
[19:51:45.158] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:10:0)
[19:51:45.158] Timer tick, asking Buildbucket for the build status
[19:51:45.225] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:51:45.225] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:11:0) after 1m0s
[19:52:45.245] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:11:0)
[19:52:45.245] Timer tick, asking Buildbucket for the build status
[19:52:45.356] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:52:45.356] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:12:0) after 1m0s
[19:53:45.400] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:12:0)
[19:53:45.400] Timer tick, asking Buildbucket for the build status
[19:53:45.508] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:53:45.508] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:13:0) after 1m0s
[19:54:45.528] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:13:0)
[19:54:45.528] Timer tick, asking Buildbucket for the build status
[19:54:45.607] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:54:45.607] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:14:0) after 1m0s
[19:55:45.640] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:14:0)
[19:55:45.640] Timer tick, asking Buildbucket for the build status
[19:55:45.723] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:55:45.723] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:15:0) after 1m0s
[19:56:45.723] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:15:0)
[19:56:45.723] Timer tick, asking Buildbucket for the build status
[19:56:45.995] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:56:45.995] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:16:0) after 1m0s
[19:57:46.011] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:16:0)
[19:57:46.011] Timer tick, asking Buildbucket for the build status
[19:57:46.102] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:57:46.102] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:17:0) after 1m0s
[19:58:46.158] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:17:0)
[19:58:46.158] Timer tick, asking Buildbucket for the build status
[19:58:46.271] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:58:46.271] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:18:0) after 1m0s
[19:59:46.289] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:18:0)
[19:59:46.289] Timer tick, asking Buildbucket for the build status
[19:59:46.557] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:59:46.557] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:19:0) after 1m0s
[20:00:46.703] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:19:0)
[20:00:46.703] Timer tick, asking Buildbucket for the build status
[20:00:46.911] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:00:46.911] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:20:0) after 1m0s
[20:01:46.972] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:20:0)
[20:01:46.972] Timer tick, asking Buildbucket for the build status
[20:01:47.038] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:01:47.038] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:21:0) after 1m0s
[20:02:47.064] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:21:0)
[20:02:47.064] Timer tick, asking Buildbucket for the build status
[20:02:47.221] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:02:47.221] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:22:0) after 1m0s
[20:03:47.248] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:22:0)
[20:03:47.248] Timer tick, asking Buildbucket for the build status
[20:03:47.503] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:03:47.503] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:23:0) after 1m0s
[20:04:47.482] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:23:0)
[20:04:47.482] Timer tick, asking Buildbucket for the build status
[20:04:47.634] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:04:47.634] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:24:0) after 1m0s
[20:05:47.701] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:24:0)
[20:05:47.701] Timer tick, asking Buildbucket for the build status
[20:05:48.122] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:05:48.122] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:25:0) after 1m0s
[20:06:48.148] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:25:0)
[20:06:48.149] Timer tick, asking Buildbucket for the build status
[20:06:48.288] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:06:48.288] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:26:0) after 1m0s
[20:07:48.335] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:26:0)
[20:07:48.335] Timer tick, asking Buildbucket for the build status
[20:07:48.401] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:07:48.401] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:27:0) after 1m0s
[20:08:48.470] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:27:0)
[20:08:48.470] Timer tick, asking Buildbucket for the build status
[20:08:48.576] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:08:48.576] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:28:0) after 1m0s
[20:09:48.558] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:28:0)
[20:09:48.558] Timer tick, asking Buildbucket for the build status
[20:09:48.637] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:09:48.637] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:29:0) after 1m0s
[20:10:48.685] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:29:0)
[20:10:48.685] Timer tick, asking Buildbucket for the build status
[20:10:48.860] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:10:48.860] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:30:0) after 1m0s
[20:11:48.904] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:30:0)
[20:11:48.905] Timer tick, asking Buildbucket for the build status
[20:11:48.966] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:11:48.966] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:31:0) after 1m0s
[20:12:48.973] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:31:0)
[20:12:48.973] Timer tick, asking Buildbucket for the build status
[20:12:49.049] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:12:49.050] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:32:0) after 1m0s
[20:13:49.083] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:32:0)
[20:13:49.083] Timer tick, asking Buildbucket for the build status
[20:13:49.165] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:13:49.165] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:33:0) after 1m0s
[20:14:49.294] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:33:0)
[20:14:49.294] Timer tick, asking Buildbucket for the build status
[20:14:49.768] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:14:49.768] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:34:0) after 1m0s
[20:15:49.777] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:34:0)
[20:15:49.777] Timer tick, asking Buildbucket for the build status
[20:15:49.960] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:15:49.960] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:35:0) after 1m0s
[20:16:50.006] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:35:0)
[20:16:50.006] Timer tick, asking Buildbucket for the build status
[20:16:50.484] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:16:50.484] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:36:0) after 1m0s
[20:17:50.517] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:36:0)
[20:17:50.517] Timer tick, asking Buildbucket for the build status
[20:17:50.614] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:17:50.614] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:37:0) after 1m0s
[20:18:50.659] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:37:0)
[20:18:50.659] Timer tick, asking Buildbucket for the build status
[20:18:50.802] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:18:50.802] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:38:0) after 1m0s
[20:19:50.846] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:38:0)
[20:19:50.846] Timer tick, asking Buildbucket for the build status
[20:19:51.219] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:19:51.219] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:39:0) after 1m0s
[20:20:51.308] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:39:0)
[20:20:51.308] Timer tick, asking Buildbucket for the build status
[20:20:51.379] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:20:51.379] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:40:0) after 1m0s
[20:21:51.408] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:40:0)
[20:21:51.408] Timer tick, asking Buildbucket for the build status
[20:21:51.476] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:21:51.476] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:41:0) after 1m0s
[20:22:51.527] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:41:0)
[20:22:51.527] Timer tick, asking Buildbucket for the build status
[20:22:51.599] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:22:51.599] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:42:0) after 1m0s
[20:23:51.680] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:42:0)
[20:23:51.680] Timer tick, asking Buildbucket for the build status
[20:23:51.855] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:23:51.855] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:43:0) after 1m0s
[20:24:51.899] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:43:0)
[20:24:51.899] Timer tick, asking Buildbucket for the build status
[20:24:51.987] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:24:51.987] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:44:0) after 1m0s
[20:25:52.027] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:44:0)
[20:25:52.027] Timer tick, asking Buildbucket for the build status
[20:25:52.810] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:25:52.810] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:45:0) after 1m0s
[20:26:52.888] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:45:0)
[20:26:52.888] Timer tick, asking Buildbucket for the build status
[20:26:52.967] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:26:52.967] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:46:0) after 1m0s
[20:27:52.995] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:46:0)
[20:27:52.995] Timer tick, asking Buildbucket for the build status
[20:27:53.118] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:27:53.118] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:47:0) after 1m0s
[20:28:53.182] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:47:0)
[20:28:53.182] Timer tick, asking Buildbucket for the build status
[20:28:53.288] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:28:53.288] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:48:0) after 1m0s
[20:29:53.472] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:48:0)
[20:29:53.472] Timer tick, asking Buildbucket for the build status
[20:29:53.567] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:29:53.567] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:49:0) after 1m0s
[20:30:53.612] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:49:0)
[20:30:53.612] Timer tick, asking Buildbucket for the build status
[20:30:53.703] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:30:53.703] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:50:0) after 1m0s
[20:31:53.814] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:50:0)
[20:31:53.814] Timer tick, asking Buildbucket for the build status
[20:31:53.944] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:31:53.944] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:51:0) after 1m0s
[20:32:53.964] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:51:0)
[20:32:53.964] Timer tick, asking Buildbucket for the build status
[20:32:54.049] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:32:54.049] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:52:0) after 1m0s
[20:33:54.053] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:52:0)
[20:33:54.053] Timer tick, asking Buildbucket for the build status
[20:33:54.154] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:33:54.154] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:53:0) after 1m0s
[20:34:54.214] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:53:0)
[20:34:54.214] Timer tick, asking Buildbucket for the build status
[20:34:54.302] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:34:54.302] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:54:0) after 1m0s
[20:35:54.360] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:54:0)
[20:35:54.360] Timer tick, asking Buildbucket for the build status
[20:35:54.701] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:35:54.701] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:55:0) after 1m0s
[20:36:54.783] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:55:0)
[20:36:54.783] Timer tick, asking Buildbucket for the build status
[20:36:54.898] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:36:54.898] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:56:0) after 1m0s
[20:37:54.950] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:56:0)
[20:37:54.950] Timer tick, asking Buildbucket for the build status
[20:37:55.184] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:37:55.184] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:57:0) after 1m0s
[20:38:55.229] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:57:0)
[20:38:55.229] Timer tick, asking Buildbucket for the build status
[20:38:55.458] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:38:55.458] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:58:0) after 1m0s
[20:39:55.498] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:58:0)
[20:39:55.498] Timer tick, asking Buildbucket for the build status
[20:39:55.584] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:39:55.584] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:59:0) after 1m0s
[20:40:55.597] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:59:0)
[20:40:55.597] Timer tick, asking Buildbucket for the build status
[20:40:55.678] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:40:55.678] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:60:0) after 1m0s
[20:41:55.682] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:60:0)
[20:41:55.682] Timer tick, asking Buildbucket for the build status
[20:41:55.774] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:41:55.774] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:61:0) after 1m0s
[20:42:55.846] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:61:0)
[20:42:55.846] Timer tick, asking Buildbucket for the build status
[20:42:55.951] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:42:55.951] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:62:0) after 1m0s
[20:43:55.964] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:62:0)
[20:43:55.964] Timer tick, asking Buildbucket for the build status
[20:43:56.074] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:43:56.074] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:63:0) after 1m0s
[20:44:56.126] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:63:0)
[20:44:56.126] Timer tick, asking Buildbucket for the build status
[20:44:56.223] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:44:56.223] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:64:0) after 1m0s
[20:45:56.251] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:64:0)
[20:45:56.251] Timer tick, asking Buildbucket for the build status
[20:45:56.336] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:45:56.336] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:65:0) after 1m0s
[20:46:56.488] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:65:0)
[20:46:56.488] Timer tick, asking Buildbucket for the build status
[20:46:56.790] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:46:56.790] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:66:0) after 1m0s
[20:47:56.832] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:66:0)
[20:47:56.832] Timer tick, asking Buildbucket for the build status
[20:47:57.213] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:47:57.213] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:67:0) after 1m0s
[20:48:57.243] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:67:0)
[20:48:57.243] Timer tick, asking Buildbucket for the build status
[20:48:57.379] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:48:57.379] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:68:0) after 1m0s
[20:49:57.481] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:68:0)
[20:49:57.481] Timer tick, asking Buildbucket for the build status
[20:49:57.720] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:49:57.720] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:69:0) after 1m0s
[20:50:57.752] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:69:0)
[20:50:57.752] Timer tick, asking Buildbucket for the build status
[20:50:57.851] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:50:57.851] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:70:0) after 1m0s
[20:51:57.871] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:70:0)
[20:51:57.871] Timer tick, asking Buildbucket for the build status
[20:51:58.134] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:51:58.134] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:71:0) after 1m0s
[20:52:58.167] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:71:0)
[20:52:58.167] Timer tick, asking Buildbucket for the build status
[20:52:58.242] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:52:58.242] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:72:0) after 1m0s
[20:53:58.261] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:72:0)
[20:53:58.261] Timer tick, asking Buildbucket for the build status
[20:53:58.389] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:53:58.389] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:73:0) after 1m0s
[20:54:58.475] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:73:0)
[20:54:58.475] Timer tick, asking Buildbucket for the build status
[20:54:58.609] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:54:58.609] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:74:0) after 1m0s
[20:55:58.688] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:74:0)
[20:55:58.688] Timer tick, asking Buildbucket for the build status
[20:55:59.152] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:55:59.152] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:75:0) after 1m0s
[20:56:59.211] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:75:0)
[20:56:59.211] Timer tick, asking Buildbucket for the build status
[20:56:59.322] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:56:59.322] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:76:0) after 1m0s
[20:57:59.322] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:76:0)
[20:57:59.322] Timer tick, asking Buildbucket for the build status
[20:57:59.407] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:57:59.407] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:77:0) after 1m0s
[20:58:59.429] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:77:0)
[20:58:59.429] Timer tick, asking Buildbucket for the build status
[20:58:59.513] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:58:59.513] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:78:0) after 1m0s
[20:59:59.574] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:78:0)
[20:59:59.574] Timer tick, asking Buildbucket for the build status
[20:59:59.659] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:59:59.659] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:79:0) after 1m0s
[21:00:59.690] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:79:0)
[21:00:59.690] Timer tick, asking Buildbucket for the build status
[21:01:02.530] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:01:02.530] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:80:0) after 1m0s
[21:02:02.555] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:80:0)
[21:02:02.555] Timer tick, asking Buildbucket for the build status
[21:02:02.660] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:02:02.660] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:81:0) after 1m0s
[21:03:02.721] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:81:0)
[21:03:02.721] Timer tick, asking Buildbucket for the build status
[21:03:02.805] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:03:02.805] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:82:0) after 1m0s
[21:04:03.064] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:82:0)
[21:04:03.064] Timer tick, asking Buildbucket for the build status
[21:04:03.199] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:04:03.199] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:83:0) after 1m0s
[21:05:03.424] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:83:0)
[21:05:03.424] Timer tick, asking Buildbucket for the build status
[21:05:03.508] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:05:03.508] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:84:0) after 1m0s
[21:06:03.695] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:84:0)
[21:06:03.695] Timer tick, asking Buildbucket for the build status
[21:06:03.805] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:06:03.805] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:85:0) after 1m0s
[21:07:03.892] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:85:0)
[21:07:03.892] Timer tick, asking Buildbucket for the build status
[21:07:03.982] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:07:03.982] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:86:0) after 1m0s
[21:08:04.037] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:86:0)
[21:08:04.037] Timer tick, asking Buildbucket for the build status
[21:08:04.140] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:08:04.140] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:87:0) after 1m0s
[21:09:06.358] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:87:0)
[21:09:06.358] Timer tick, asking Buildbucket for the build status
[21:09:06.484] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:09:06.484] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:88:0) after 1m0s
[21:10:06.621] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:88:0)
[21:10:06.621] Timer tick, asking Buildbucket for the build status
[21:10:06.711] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:10:06.711] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:89:0) after 1m0s
[21:11:06.736] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:89:0)
[21:11:06.736] Timer tick, asking Buildbucket for the build status
[21:11:06.889] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:11:06.889] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:90:0) after 1m0s
[21:12:06.930] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:90:0)
[21:12:06.930] Timer tick, asking Buildbucket for the build status
[21:12:07.039] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:12:07.039] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:91:0) after 1m0s
[21:13:07.124] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:91:0)
[21:13:07.124] Timer tick, asking Buildbucket for the build status
[21:13:07.223] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:13:07.223] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:92:0) after 1m0s
[21:14:07.358] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:92:0)
[21:14:07.358] Timer tick, asking Buildbucket for the build status
[21:14:07.494] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:14:07.494] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:93:0) after 1m0s
[21:15:07.648] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:93:0)
[21:15:07.648] Timer tick, asking Buildbucket for the build status
[21:15:08.042] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:15:08.042] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:94:0) after 1m0s
[21:16:08.121] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:94:0)
[21:16:08.121] Timer tick, asking Buildbucket for the build status
[21:16:08.224] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:16:08.224] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:95:0) after 1m0s
[21:17:08.331] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:95:0)
[21:17:08.331] Timer tick, asking Buildbucket for the build status
[21:17:08.417] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:17:08.417] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:96:0) after 1m0s
[21:18:08.489] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:96:0)
[21:18:08.489] Timer tick, asking Buildbucket for the build status
[21:18:08.607] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:18:08.607] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:97:0) after 1m0s
[21:19:08.766] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:97:0)
[21:19:08.766] Timer tick, asking Buildbucket for the build status
[21:19:09.737] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:19:09.737] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:98:0) after 1m0s
[21:20:09.800] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:98:0)
[21:20:09.800] Timer tick, asking Buildbucket for the build status
[21:20:09.881] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:20:09.881] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:99:0) after 1m0s
[21:21:09.957] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:99:0)
[21:21:09.957] Timer tick, asking Buildbucket for the build status
[21:21:10.117] Build 8854386717689332480: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:21:10.117] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019816779623173632:100:0) after 1m0s
[21:21:47.995] Received PubSub notification, asking Buildbucket for the build status
[21:21:48.137] Build 8854386717689332480: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[21:21:48.137] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1614201707268734",
"created_by": "project:chromium",
"created_ts": "1614195822019502",
"failure_reason": "BUILD_FAILURE",
"id": "8854386717689332480",
"parameters_json": "{\"builder_name\": \"linux-chromeos-dbg\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"b0d235a2b8efc7d2a8241c24038cd5f57ae72e45\"}}",
"project": "chromium",
"result": "FAILURE",
"result_details_json": "{\"error\": {\"message\": \"1 Test Suite(s) failed.\\n\\n**browser_tests** failed because of:\\n\\n- UserSelectionScreenBlockOfflineTest.HideOfflineLink\\n\\n- UserSelectionScreenBlockOfflineTest.OfflineLimitNotSet\\n\\n- UserSelectionScreenBlockOfflineTest.ShowOfflineLink\"}, \"properties\": {\"$build/goma\": {\"enable_ats\": true, \"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\": \"b0d235a2b8efc7d2a8241c24038cd5f57ae72e45\", \"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-east1-d-8-76-83di\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.chromiumos\", \"buildername\": \"linux-chromeos-dbg\", \"buildnumber\": 22765, \"got_angle_revision\": \"9b9d683e9cc3ceaa07cc501e5667779db791c0cd\", \"got_dawn_revision\": \"018b9b917c1d15accd3854b9248b8b6c1a91f6fe\", \"got_nacl_revision\": \"abf3277f295c6c87f0b103f291ed5e3e73933b76\", \"got_revision\": \"b0d235a2b8efc7d2a8241c24038cd5f57ae72e45\", \"got_revision_cp\": \"refs/heads/master@{#857307}\", \"got_swarming_client_revision\": \"a32a1607f6093d338f756c7e7c7b4333b0c50c9c\", \"got_swiftshader_revision\": \"22186f076bf3bbe1a818792bde93b297e3773f7e\", \"got_v8_revision\": \"bd0108b4c88e0d6f2350cb79b5f363fbd02f3eb7\", \"got_v8_revision_cp\": \"refs/heads/9.0.257@{#1}\", \"got_webrtc_revision\": \"d0844a80deaab28d7df8e5dff9f71e6ab6919025\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#33323}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"mirrored_builders\": [\"tryserver.chromium.chromiumos:linux-chromeos-dbg\", \"tryserver.chromium.chromiumos:linux-chromeos-compile-dbg\"], \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"b0d235a2b8efc7d2a8241c24038cd5f57ae72e45\", \"swarm_hashes_refs/heads/master(at){#857307}_without_patch\": {\"absl_hardening_tests\": \"4bfa55f6ff204cd777d1cc1bd86f256f3689a7b3\", \"accessibility_unittests\": \"c6b36a4eec0e78b7bef97e9fea27b13fbc2036fd\", \"angle_unittests\": \"bf4ca6d90af5fa1a7d481708f49f2e06bb128e68\", \"app_list_unittests\": \"2723202945fd073c252bb121637b9635191bcadc\", \"app_shell_unittests\": \"6dc03d23027280ba2409d9cb110db6548c107a8d\", \"ash_unittests\": \"aa80a4f084cb43b7d592a41ddecf433ddc188800\", \"aura_unittests\": \"7313aabfdc226515d12ba636ab32f6a5a0701ab5\", \"base_unittests\": \"fcda59091064fed60a0b8a5ed491fb9debe83b3c\", \"base_util_unittests\": \"8cba35ef45f4d3f14ab8ce41c840c1a625dc99d5\", \"blink_common_unittests\": \"0276ad6404b700c3aac44cc48ca7b496096186a3\", \"blink_fuzzer_unittests\": \"81a77861de5f9956039a784aa28d98e9b3f680db\", \"blink_heap_unittests\": \"44118b70202c9de4a303170f44a35a5a2fc7cc67\", \"blink_platform_unittests\": \"e4a3db33b75d4c3968cac36d0bfd1702b03728af\", \"blink_unittests\": \"795e0b54891f2f249599ac006a6bfc5e1c610a8d\", \"boringssl_crypto_tests\": \"b545064c28349bb07327b412676c064c02137b27\", \"boringssl_ssl_tests\": \"c37afb3615db0d3c2230e86479d2b93ab3bc5b55\", \"browser_tests\": \"1026793cb6a889c289f4cdb2730fe7479afb02b0\", \"capture_unittests\": \"abc71bcf783f66d7b37ec017508d85ddde723397\", \"cast_unittests\": \"2c42cd13190175e4625512befc5e6ecdd27ecaa3\", \"cc_unittests\": \"15f197209b6b341970a58f0842236ede960f2d96\", \"chrome_app_unittests\": \"91c99c1598f8600b94c519df2754d8ad30764550\", \"chromedriver_unittests\": \"19686e7b087e1b62ada1ad718fd071e7beb60de8\", \"chromeos_components_unittests\": \"3ce60a9cf89bae4c795e4ef5f73c9654fb219f12\", \"chromeos_unittests\": \"81077409a9a955beee76158aa36d1c56078c53a8\", \"color_unittests\": \"dd913758edbd18a5a0cfbff0cecc879cf36528c9\", \"components_browsertests\": \"af3c295c3760d8f5a234662481fd70444257e7a3\", \"components_unittests\": \"80d4711edbdbca2ab37519f61ae9ee8d25102d63\", \"compositor_unittests\": \"be1e33e41fc4ad654ed8753e4b46950bf4603d78\", \"content_browsertests\": \"f991ff07a272adfacd6f93b4f421524b1bd33906\", \"content_unittests\": \"cad6c8c37469db8c9cac35873eb89078590e1589\", \"crashpad_tests\": \"953c12b3c5b8c82aece7f3cc1bbe7dffdb94057b\", \"crypto_unittests\": \"d0b31e36ae9693a2494ae4d0736b2d2e7bfc785e\", \"dbus_unittests\": \"9c91a9afc2bff0be4db33a0af18e83da39949a9d\", \"device_unittests\": \"39c79c0052b988e91278d717df4ee734106bbbf0\", \"display_unittests\": \"e44dde2f48ccef3bdbe1183b769efb4bdfce35ce\", \"events_unittests\": \"5f8d4de4a454ae360285660d2ffc7592ae6c0dad\", \"exo_unittests\": \"56ac4dab248eba1ee594e35a075aed44284d4c7e\", \"extensions_browsertests\": \"1ae6e0829aedd87ca4685c0bed975231a820b444\", \"extensions_unittests\": \"7484f7767d367be46a08d905b2ecb6b443e2c2ed\", \"filesystem_service_unittests\": \"3f9d16875b0ac7f0cd5c1b59b24a73454f655ef6\", \"gcm_unit_tests\": \"72eaf6db4389467fbf288579fc61e7b0c74f0080\", \"gfx_unittests\": \"3db1b2eefcbf8416527f83f3c20a18474cb32016\", \"gin_unittests\": \"cd23fd261c513ef022b3e8a6c3995cf3316d6cfc\", \"gl_unittests_ozone\": \"b8197c741c55b0cc387428171fd297a30b4cd12e\", \"google_apis_unittests\": \"4e1929d5c9233a86f8117240a9527117aa8281d0\", \"gpu_unittests\": \"aeb4671f732ece41c1fd13add1eab99aa3ab8ea2\", \"gwp_asan_unittests\": \"76f5eb126d759d5d979e2cd74a491484624d8ff9\", \"interactive_ui_tests\": \"b76455cfede03bc6d08f11240b3db5acb5fedf9c\", \"ipc_tests\": \"207d0deea339c031f28fe83a14ca38e407faa80b\", \"jingle_unittests\": \"52b719ac80ffd48fd045e8deaa28aedbdbb601cb\", \"keyboard_unittests\": \"50a498c3b3400e36b4665c3266f37453c63e79d0\", \"latency_unittests\": \"be954a89ca66aad9dc49a81f7eeee2a13ebe1d67\", \"libjingle_xmpp_unittests\": \"cf0d37e9a98a49e110e6021a0dd914239b37145e\", \"liburlpattern_unittests\": \"7ad0332d9db6b37ffd1a7463c234774831be25df\", \"media_blink_unittests\": \"d224c73c2e01739799a98a32bedd90c63e5ce073\", \"media_unittests\": \"f2e44be66ebe57a19322e26b41ff45031d6bc970\", \"message_center_unittests\": \"904848bb70a7cbd2b072b1ff4522fec9b3f80caa\", \"midi_unittests\": \"fcd9ef61e8cb662b8db2a00af84d96238cdc0570\", \"mojo_core_unittests\": \"87b7559b32f07c5c3695d51507a59c2b7e29c4cf\", \"mojo_unittests\": \"73dacb1c3b98209c5985a231706add6909950a19\", \"nacl_helper_nonsfi_unittests\": \"fe2d67a6e274176b6b3a9e370754b454bc8cbbba\", \"nacl_loader_unittests\": \"30a2e0dd91442bb347a86cc0a7c75ac86ff4f35c\", \"native_theme_unittests\": \"fa1d58ae3cf797ab093dacebf871c0daf8337d86\", \"net_unittests\": \"94c39a52ec4039cfbfe25ec50deddaa58578e202\", \"ozone_gl_unittests\": \"5c5161d1f79612a9489e6ab131e6089d37f7d852\", \"ozone_unittests\": \"c2dfe80b61f5374af82b15cce6d8a2e31cd98d25\", \"ozone_x11_unittests\": \"8d5059aec1f2c79a52498ee053c2d4f5a2582c9a\", \"pdf_unittests\": \"cc30c23b370dcf3595e6c91498f4cf857bbbf08b\", \"perfetto_unittests\": \"e989e914a6c2cd7d9e8df34db9a6517c389de895\", \"ppapi_unittests\": \"e334e7e06a7918899e32101550c250e14c2ac319\", \"printing_unittests\": \"3c48024d36f6230ca76f3ebb7fbcdbadb13fcc36\", \"remoting_unittests\": \"66f0577bf29351568dfc64e34327b3c25fa31f8b\", \"sandbox_linux_unittests\": \"1561b9a9851bf411b32077f19f672996a2ad5610\", \"service_manager_unittests\": \"3f563e45a85032b63ef4d5e0a1c95b0e2582085f\", \"services_unittests\": \"6600b405784ea162a264e552772afc199e2f85bd\", \"shell_dialogs_unittests\": \"68ca915ed736502a07a3d5eb70c4bee5bbb5a7bd\", \"shell_encryption_unittests\": \"8252153c7140e2fcea7e2110e9c7ed99d6e15035\", \"skia_unittests\": \"7b46f9cb17848b67a6a921f3c00fc81a3b89fcdf\", \"snapshot_unittests\": \"8d7a11bb40398891810b2cb95e87a636770f90a2\", \"sql_unittests\": \"59de4a0ad0abf295f26e6809efff8f10edc82471\", \"storage_unittests\": \"1d9e4762c96edc29c47787c188a78b9fc4afaa04\", \"sync_integration_tests\": \"9786af8409c3f70ec9cb15c8713fe97385a44b13\", \"traffic_annotation_auditor_unittests\": \"4840d4ac3933e5fb0d69cd116d1daa5450e6b540\", \"ui_base_unittests\": \"3d305e951da54094578326249805bc7e85864d72\", \"ui_chromeos_unittests\": \"5522fb71a99cea55d270c9195a9a7e5ead7ea0fc\", \"ui_touch_selection_unittests\": \"8640121172e28e1e0112ed9d6a68eab5862554a7\", \"unit_tests\": \"ae664f604802ff4c6eab3af85be83d894ce21b43\", \"url_unittests\": \"17960a5dc5d3b79cb9af4535f058d7e4c438164f\", \"usage_time_limit_unittests\": \"2fc3dd7ff79b004c7b5905f5cdd65c5e10ae366f\", \"views_unittests\": \"b60c3f548099f16632592d9b60e3a037ca951547\", \"viz_unittests\": \"ce1bebe9093a79304845e768c79c1b544abae804\", \"wm_unittests\": \"f8ada484172737aa23bcd1b1462755cb3552ef1a\", \"wtf_unittests\": \"453046af43c1f066ac915b2aa70520f188bd0367\", \"zlib_unittests\": \"f3f2431143345822a19adc0c331e375464de1f04\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_4973d939604d11dcbaec68575e69c80c756ff63e355ab013b29b8bca26434b7c_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-east1-d-8-76-83di\"], \"image\": [\"chrome-xenial-21011100-9488e34e558\"], \"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\": [\"5709-d3c4474\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-east\", \"us-east1\", \"us-east1-d\"]}}, \"ui\": {\"info\": \"1 Test Suite(s) failed.\\n\\n**browser_tests** failed because of:\\n\\n- UserSelectionScreenBlockOfflineTest.HideOfflineLink\\n\\n- UserSelectionScreenBlockOfflineTest.OfflineLimitNotSet\\n\\n- UserSelectionScreenBlockOfflineTest.ShowOfflineLink\"}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1614195960606403",
"status": "COMPLETED",
"status_changed_ts": "1614195963149724",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-dbg/22765",
"builder:linux-chromeos-dbg",
"buildset:commit/git/b0d235a2b8efc7d2a8241c24038cd5f57ae72e45",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/b0d235a2b8efc7d2a8241c24038cd5f57ae72e45",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9019816779623173632",
"scheduler_job_id:chromium/linux-chromeos-dbg",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8854386717689332480/+/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:51ee631a736c2b10",
"user_agent:luci-scheduler"
],
"updated_ts": "1614201707269349",
"url": "https://ci.chromium.org/b/8854386717689332480",
"utcnow_ts": "1614201708128931"
}
}
[21:21:48.137] Invocation finished in 1h38m7.346045685s with status FAILED