[04:32:30.372] New invocation is queued and will start shortly
[04:32:31.539] Starting the invocation (attempt 1)
[04:32:31.572] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[04:32:31.572] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[04:32:31.572] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9023044999558017888",
"parameters_json": "{\"builder_name\":\"linux-chromeos-dbg\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"abb0ef991720bf5394a20f5cf77270ce923b72c9\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:linux-chromeos-dbg",
"scheduler_invocation_id:9023044999558017888",
"scheduler_job_id:chromium/linux-chromeos-dbg",
"user_agent:luci-scheduler",
"buildset:commit/git/abb0ef991720bf5394a20f5cf77270ce923b72c9",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/abb0ef991720bf5394a20f5cf77270ce923b72c9",
"gitiles_ref:refs/heads/master"
]
}
[04:32:32.302] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1611117151650539",
"id": "8857614937549741584",
"parameters_json": "{\"builder_name\": \"linux-chromeos-dbg\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"abb0ef991720bf5394a20f5cf77270ce923b72c9\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1611117152085001",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-dbg/22266",
"builder:linux-chromeos-dbg",
"buildset:commit/git/abb0ef991720bf5394a20f5cf77270ce923b72c9",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/abb0ef991720bf5394a20f5cf77270ce923b72c9",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9023044999558017888",
"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/8857614937549741584/+/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": "1611117152085119",
"url": "https://ci.chromium.org/b/8857614937549741584",
"utcnow_ts": "1611117152271399"
}
}
[04:32:32.302] Task URL: https://ci.chromium.org/b/8857614937549741584
[04:32:32.302] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:2:0) after 1m0s
[04:32:44.503] Received PubSub notification, asking Buildbucket for the build status
[04:32:44.565] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:33:32.354] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:2:0)
[04:33:32.354] Timer tick, asking Buildbucket for the build status
[04:33:32.816] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:33:32.816] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:4:0) after 1m0s
[04:34:32.867] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:4:0)
[04:34:32.867] Timer tick, asking Buildbucket for the build status
[04:34:32.987] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:34:32.987] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:5:0) after 1m0s
[04:35:33.009] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:5:0)
[04:35:33.009] Timer tick, asking Buildbucket for the build status
[04:35:33.282] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:35:33.282] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:6:0) after 1m0s
[04:36:33.259] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:6:0)
[04:36:33.259] Timer tick, asking Buildbucket for the build status
[04:36:33.389] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:36:33.389] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:7:0) after 1m0s
[04:37:33.449] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:7:0)
[04:37:33.449] Timer tick, asking Buildbucket for the build status
[04:37:33.624] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:37:33.624] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:8:0) after 1m0s
[04:38:33.625] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:8:0)
[04:38:33.625] Timer tick, asking Buildbucket for the build status
[04:38:33.783] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:38:33.783] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:9:0) after 1m0s
[04:39:33.804] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:9:0)
[04:39:33.804] Timer tick, asking Buildbucket for the build status
[04:39:33.945] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:39:33.945] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:10:0) after 1m0s
[04:40:34.018] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:10:0)
[04:40:34.018] Timer tick, asking Buildbucket for the build status
[04:40:34.332] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:40:34.332] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:11:0) after 1m0s
[04:41:34.351] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:11:0)
[04:41:34.351] Timer tick, asking Buildbucket for the build status
[04:41:34.423] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:41:34.423] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:12:0) after 1m0s
[04:42:34.445] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:12:0)
[04:42:34.445] Timer tick, asking Buildbucket for the build status
[04:42:34.522] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:42:34.522] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:13:0) after 1m0s
[04:43:34.540] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:13:0)
[04:43:34.540] Timer tick, asking Buildbucket for the build status
[04:43:34.651] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:43:34.651] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:14:0) after 1m0s
[04:44:34.676] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:14:0)
[04:44:34.676] Timer tick, asking Buildbucket for the build status
[04:44:34.849] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:44:34.849] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:15:0) after 1m0s
[04:45:34.897] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:15:0)
[04:45:34.897] Timer tick, asking Buildbucket for the build status
[04:45:34.959] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:45:34.959] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:16:0) after 1m0s
[04:46:34.946] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:16:0)
[04:46:34.946] Timer tick, asking Buildbucket for the build status
[04:46:34.999] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:46:34.999] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:17:0) after 1m0s
[04:47:35.052] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:17:0)
[04:47:35.052] Timer tick, asking Buildbucket for the build status
[04:47:35.141] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:47:35.141] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:18:0) after 1m0s
[04:48:35.165] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:18:0)
[04:48:35.165] Timer tick, asking Buildbucket for the build status
[04:48:35.483] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:48:35.483] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:19:0) after 1m0s
[04:49:35.502] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:19:0)
[04:49:35.502] Timer tick, asking Buildbucket for the build status
[04:49:35.566] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:49:35.566] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:20:0) after 1m0s
[04:50:35.606] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:20:0)
[04:50:35.606] Timer tick, asking Buildbucket for the build status
[04:50:36.006] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:50:36.006] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:21:0) after 1m0s
[04:51:36.055] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:21:0)
[04:51:36.055] Timer tick, asking Buildbucket for the build status
[04:51:36.116] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:51:36.116] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:22:0) after 1m0s
[04:52:36.102] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:22:0)
[04:52:36.102] Timer tick, asking Buildbucket for the build status
[04:52:36.158] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:52:36.158] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:23:0) after 1m0s
[04:53:36.177] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:23:0)
[04:53:36.177] Timer tick, asking Buildbucket for the build status
[04:53:36.279] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:53:36.279] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:24:0) after 1m0s
[04:54:36.301] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:24:0)
[04:54:36.301] Timer tick, asking Buildbucket for the build status
[04:54:36.358] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:54:36.358] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:25:0) after 1m0s
[04:55:36.466] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:25:0)
[04:55:36.466] Timer tick, asking Buildbucket for the build status
[04:55:36.521] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:55:36.521] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:26:0) after 1m0s
[04:56:36.662] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:26:0)
[04:56:36.662] Timer tick, asking Buildbucket for the build status
[04:56:36.751] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:56:36.751] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:27:0) after 1m0s
[04:57:36.795] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:27:0)
[04:57:36.795] Timer tick, asking Buildbucket for the build status
[04:57:36.854] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:57:36.854] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:28:0) after 1m0s
[04:58:36.924] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:28:0)
[04:58:36.924] Timer tick, asking Buildbucket for the build status
[04:58:37.503] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:58:37.503] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:29:0) after 1m0s
[04:59:37.527] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:29:0)
[04:59:37.527] Timer tick, asking Buildbucket for the build status
[04:59:37.597] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:59:37.597] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:30:0) after 1m0s
[05:00:37.625] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:30:0)
[05:00:37.625] Timer tick, asking Buildbucket for the build status
[05:00:37.682] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:00:37.682] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:31:0) after 1m0s
[05:01:37.680] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:31:0)
[05:01:37.680] Timer tick, asking Buildbucket for the build status
[05:01:37.829] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:01:37.829] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:32:0) after 1m0s
[05:02:37.847] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:32:0)
[05:02:37.847] Timer tick, asking Buildbucket for the build status
[05:02:37.921] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:02:37.921] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:33:0) after 1m0s
[05:03:37.940] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:33:0)
[05:03:37.940] Timer tick, asking Buildbucket for the build status
[05:03:38.211] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:03:38.211] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:34:0) after 1m0s
[05:04:38.223] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:34:0)
[05:04:38.223] Timer tick, asking Buildbucket for the build status
[05:04:38.342] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:04:38.342] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:35:0) after 1m0s
[05:05:38.382] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:35:0)
[05:05:38.382] Timer tick, asking Buildbucket for the build status
[05:05:38.454] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:05:38.454] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:36:0) after 1m0s
[05:06:38.509] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:36:0)
[05:06:38.509] Timer tick, asking Buildbucket for the build status
[05:06:38.582] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:06:38.582] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:37:0) after 1m0s
[05:07:38.647] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:37:0)
[05:07:38.647] Timer tick, asking Buildbucket for the build status
[05:07:38.740] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:07:38.740] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:38:0) after 1m0s
[05:08:38.762] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:38:0)
[05:08:38.762] Timer tick, asking Buildbucket for the build status
[05:08:39.102] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:08:39.102] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:39:0) after 1m0s
[05:09:39.155] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:39:0)
[05:09:39.155] Timer tick, asking Buildbucket for the build status
[05:09:39.216] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:09:39.216] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:40:0) after 1m0s
[05:10:39.272] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:40:0)
[05:10:39.272] Timer tick, asking Buildbucket for the build status
[05:10:39.338] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:10:39.338] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:41:0) after 1m0s
[05:11:39.394] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:41:0)
[05:11:39.394] Timer tick, asking Buildbucket for the build status
[05:11:39.461] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:11:39.461] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:42:0) after 1m0s
[05:12:39.504] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:42:0)
[05:12:39.504] Timer tick, asking Buildbucket for the build status
[05:12:39.585] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:12:39.585] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:43:0) after 1m0s
[05:13:39.615] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:43:0)
[05:13:39.615] Timer tick, asking Buildbucket for the build status
[05:13:39.746] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:13:39.746] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:44:0) after 1m0s
[05:14:39.792] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:44:0)
[05:14:39.792] Timer tick, asking Buildbucket for the build status
[05:14:39.859] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:14:39.859] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:45:0) after 1m0s
[05:15:39.916] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:45:0)
[05:15:39.916] Timer tick, asking Buildbucket for the build status
[05:15:39.989] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:15:39.989] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:46:0) after 1m0s
[05:16:40.078] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:46:0)
[05:16:40.078] Timer tick, asking Buildbucket for the build status
[05:16:40.429] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:16:40.429] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:47:0) after 1m0s
[05:17:40.479] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:47:0)
[05:17:40.479] Timer tick, asking Buildbucket for the build status
[05:17:40.562] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:17:40.562] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:48:0) after 1m0s
[05:18:40.574] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:48:0)
[05:18:40.574] Timer tick, asking Buildbucket for the build status
[05:18:40.671] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:18:40.671] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:49:0) after 1m0s
[05:19:40.731] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:49:0)
[05:19:40.731] Timer tick, asking Buildbucket for the build status
[05:19:40.933] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:19:40.933] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:50:0) after 1m0s
[05:20:40.954] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:50:0)
[05:20:40.954] Timer tick, asking Buildbucket for the build status
[05:20:41.347] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:20:41.347] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:51:0) after 1m0s
[05:21:41.473] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:51:0)
[05:21:41.473] Timer tick, asking Buildbucket for the build status
[05:21:41.880] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:21:41.880] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:52:0) after 1m0s
[05:22:41.922] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:52:0)
[05:22:41.922] Timer tick, asking Buildbucket for the build status
[05:22:42.023] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:22:42.023] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:53:0) after 1m0s
[05:23:42.055] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:53:0)
[05:23:42.055] Timer tick, asking Buildbucket for the build status
[05:23:42.212] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:23:42.212] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:54:0) after 1m0s
[05:24:42.246] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:54:0)
[05:24:42.246] Timer tick, asking Buildbucket for the build status
[05:24:42.412] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:24:42.412] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:55:0) after 1m0s
[05:25:42.487] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:55:0)
[05:25:42.487] Timer tick, asking Buildbucket for the build status
[05:25:42.798] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:25:42.798] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:56:0) after 1m0s
[05:26:42.772] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:56:0)
[05:26:42.772] Timer tick, asking Buildbucket for the build status
[05:26:43.103] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:26:43.103] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:57:0) after 1m0s
[05:27:43.126] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:57:0)
[05:27:43.126] Timer tick, asking Buildbucket for the build status
[05:27:43.994] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:27:43.994] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:58:0) after 1m0s
[05:28:44.091] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:58:0)
[05:28:44.091] Timer tick, asking Buildbucket for the build status
[05:28:44.193] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:28:44.193] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:59:0) after 1m0s
[05:29:44.261] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:59:0)
[05:29:44.261] Timer tick, asking Buildbucket for the build status
[05:29:44.327] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:29:44.327] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:60:0) after 1m0s
[05:30:44.369] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:60:0)
[05:30:44.369] Timer tick, asking Buildbucket for the build status
[05:30:44.695] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:30:44.695] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:61:0) after 1m0s
[05:31:44.756] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:61:0)
[05:31:44.756] Timer tick, asking Buildbucket for the build status
[05:31:44.870] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:31:44.870] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:62:0) after 1m0s
[05:32:44.954] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:62:0)
[05:32:44.954] Timer tick, asking Buildbucket for the build status
[05:32:45.101] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:32:45.101] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:63:0) after 1m0s
[05:33:45.116] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:63:0)
[05:33:45.116] Timer tick, asking Buildbucket for the build status
[05:33:45.251] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:33:45.251] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:64:0) after 1m0s
[05:34:45.284] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:64:0)
[05:34:45.284] Timer tick, asking Buildbucket for the build status
[05:34:45.382] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:34:45.382] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:65:0) after 1m0s
[05:35:45.406] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:65:0)
[05:35:45.406] Timer tick, asking Buildbucket for the build status
[05:35:45.802] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:35:45.802] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:66:0) after 1m0s
[05:36:45.890] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:66:0)
[05:36:45.890] Timer tick, asking Buildbucket for the build status
[05:36:46.017] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:36:46.017] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:67:0) after 1m0s
[05:37:46.060] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:67:0)
[05:37:46.060] Timer tick, asking Buildbucket for the build status
[05:37:46.165] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:37:46.165] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:68:0) after 1m0s
[05:38:46.207] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:68:0)
[05:38:46.207] Timer tick, asking Buildbucket for the build status
[05:38:47.847] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:38:47.847] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:69:0) after 1m0s
[05:39:47.892] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:69:0)
[05:39:47.892] Timer tick, asking Buildbucket for the build status
[05:39:48.020] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:39:48.020] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:70:0) after 1m0s
[05:40:48.026] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:70:0)
[05:40:48.026] Timer tick, asking Buildbucket for the build status
[05:40:48.104] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:40:48.104] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:71:0) after 1m0s
[05:41:48.308] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:71:0)
[05:41:48.308] Timer tick, asking Buildbucket for the build status
[05:41:48.686] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:41:48.686] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:72:0) after 1m0s
[05:42:48.793] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:72:0)
[05:42:48.793] Timer tick, asking Buildbucket for the build status
[05:42:48.906] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:42:48.906] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:73:0) after 1m0s
[05:43:49.147] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:73:0)
[05:43:49.147] Timer tick, asking Buildbucket for the build status
[05:43:49.265] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:43:49.265] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:74:0) after 1m0s
[05:44:49.431] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:74:0)
[05:44:49.431] Timer tick, asking Buildbucket for the build status
[05:44:49.547] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:44:49.547] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:75:0) after 1m0s
[05:45:49.594] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:75:0)
[05:45:49.594] Timer tick, asking Buildbucket for the build status
[05:45:49.850] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:45:49.850] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:76:0) after 1m0s
[05:46:49.897] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:76:0)
[05:46:49.897] Timer tick, asking Buildbucket for the build status
[05:46:50.075] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:46:50.075] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:77:0) after 1m0s
[05:47:50.116] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:77:0)
[05:47:50.116] Timer tick, asking Buildbucket for the build status
[05:47:50.420] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:47:50.420] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:78:0) after 1m0s
[05:48:50.454] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:78:0)
[05:48:50.454] Timer tick, asking Buildbucket for the build status
[05:48:50.535] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:48:50.535] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:79:0) after 1m0s
[05:49:50.741] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:79:0)
[05:49:50.741] Timer tick, asking Buildbucket for the build status
[05:49:50.877] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:49:50.877] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:80:0) after 1m0s
[05:50:50.969] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:80:0)
[05:50:50.969] Timer tick, asking Buildbucket for the build status
[05:50:51.112] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:50:51.112] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:81:0) after 1m0s
[05:51:51.180] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:81:0)
[05:51:51.180] Timer tick, asking Buildbucket for the build status
[05:51:51.302] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:51:51.302] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:82:0) after 1m0s
[05:52:51.372] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:82:0)
[05:52:51.372] Timer tick, asking Buildbucket for the build status
[05:52:51.489] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:52:51.489] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:83:0) after 1m0s
[05:53:52.762] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:83:0)
[05:53:52.762] Timer tick, asking Buildbucket for the build status
[05:53:53.196] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:53:53.196] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:84:0) after 1m0s
[05:54:53.240] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:84:0)
[05:54:53.240] Timer tick, asking Buildbucket for the build status
[05:54:53.342] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:54:53.342] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:85:0) after 1m0s
[05:55:53.440] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:85:0)
[05:55:53.440] Timer tick, asking Buildbucket for the build status
[05:55:53.609] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:55:53.609] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:86:0) after 1m0s
[05:56:53.655] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:86:0)
[05:56:53.655] Timer tick, asking Buildbucket for the build status
[05:56:53.721] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:56:53.721] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:87:0) after 1m0s
[05:57:53.741] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:87:0)
[05:57:53.741] Timer tick, asking Buildbucket for the build status
[05:57:53.922] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:57:53.922] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:88:0) after 1m0s
[05:58:53.948] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:88:0)
[05:58:53.948] Timer tick, asking Buildbucket for the build status
[05:58:54.034] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:58:54.034] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:89:0) after 1m0s
[05:59:54.060] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:89:0)
[05:59:54.060] Timer tick, asking Buildbucket for the build status
[05:59:54.142] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:59:54.142] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:90:0) after 1m0s
[06:00:54.170] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:90:0)
[06:00:54.170] Timer tick, asking Buildbucket for the build status
[06:00:54.253] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:00:54.253] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:91:0) after 1m0s
[06:01:54.343] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:91:0)
[06:01:54.343] Timer tick, asking Buildbucket for the build status
[06:01:54.438] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:01:54.438] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:92:0) after 1m0s
[06:02:54.500] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:92:0)
[06:02:54.500] Timer tick, asking Buildbucket for the build status
[06:02:54.917] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:02:54.917] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:93:0) after 1m0s
[06:03:54.907] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:93:0)
[06:03:54.907] Timer tick, asking Buildbucket for the build status
[06:03:55.118] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:03:55.118] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:94:0) after 1m0s
[06:04:55.139] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:94:0)
[06:04:55.139] Timer tick, asking Buildbucket for the build status
[06:04:55.251] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:04:55.251] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:95:0) after 1m0s
[06:05:55.318] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:95:0)
[06:05:55.318] Timer tick, asking Buildbucket for the build status
[06:05:55.595] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:05:55.595] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:96:0) after 1m0s
[06:06:55.631] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:96:0)
[06:06:55.631] Timer tick, asking Buildbucket for the build status
[06:06:55.705] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:06:55.705] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:97:0) after 1m0s
[06:07:55.697] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:97:0)
[06:07:55.697] Timer tick, asking Buildbucket for the build status
[06:07:55.985] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:07:55.985] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:98:0) after 1m0s
[06:08:56.014] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:98:0)
[06:08:56.014] Timer tick, asking Buildbucket for the build status
[06:08:56.439] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:08:56.439] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:99:0) after 1m0s
[06:09:56.494] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:99:0)
[06:09:56.495] Timer tick, asking Buildbucket for the build status
[06:09:56.577] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:09:56.577] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:100:0) after 1m0s
[06:10:56.601] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:100:0)
[06:10:56.601] Timer tick, asking Buildbucket for the build status
[06:10:56.685] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:10:56.685] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:101:0) after 1m0s
[06:11:56.736] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:101:0)
[06:11:56.736] Timer tick, asking Buildbucket for the build status
[06:11:56.885] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:11:56.885] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:102:0) after 1m0s
[06:12:56.893] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:102:0)
[06:12:56.893] Timer tick, asking Buildbucket for the build status
[06:12:57.094] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:12:57.094] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:103:0) after 1m0s
[06:13:57.169] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:103:0)
[06:13:57.169] Timer tick, asking Buildbucket for the build status
[06:13:57.282] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:13:57.282] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:104:0) after 1m0s
[06:14:57.305] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:104:0)
[06:14:57.305] Timer tick, asking Buildbucket for the build status
[06:14:57.622] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:14:57.622] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:105:0) after 1m0s
[06:15:57.697] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:105:0)
[06:15:57.697] Timer tick, asking Buildbucket for the build status
[06:15:58.134] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:15:58.134] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:106:0) after 1m0s
[06:16:58.227] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:106:0)
[06:16:58.227] Timer tick, asking Buildbucket for the build status
[06:16:58.299] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:16:58.299] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:107:0) after 1m0s
[06:17:58.327] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:107:0)
[06:17:58.327] Timer tick, asking Buildbucket for the build status
[06:17:58.913] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:17:58.913] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:108:0) after 1m0s
[06:18:59.024] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:108:0)
[06:18:59.024] Timer tick, asking Buildbucket for the build status
[06:18:59.096] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:18:59.096] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:109:0) after 1m0s
[06:19:59.143] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:109:0)
[06:19:59.143] Timer tick, asking Buildbucket for the build status
[06:19:59.223] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:19:59.223] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:110:0) after 1m0s
[06:20:59.253] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:110:0)
[06:20:59.253] Timer tick, asking Buildbucket for the build status
[06:20:59.417] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:20:59.417] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:111:0) after 1m0s
[06:21:59.448] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:111:0)
[06:21:59.448] Timer tick, asking Buildbucket for the build status
[06:21:59.519] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:21:59.519] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:112:0) after 1m0s
[06:22:59.645] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:112:0)
[06:22:59.645] Timer tick, asking Buildbucket for the build status
[06:22:59.939] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:22:59.939] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:113:0) after 1m0s
[06:24:00.089] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:113:0)
[06:24:00.089] Timer tick, asking Buildbucket for the build status
[06:24:00.505] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:24:00.505] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:114:0) after 1m0s
[06:25:01.086] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:114:0)
[06:25:01.086] Timer tick, asking Buildbucket for the build status
[06:25:01.435] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:25:01.435] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:115:0) after 1m0s
[06:26:01.884] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:115:0)
[06:26:01.884] Timer tick, asking Buildbucket for the build status
[06:26:02.333] Build 8857614937549741584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:26:02.333] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023044999558017888:116:0) after 1m0s
[06:26:38.641] Received PubSub notification, asking Buildbucket for the build status
[06:26:38.784] Build 8857614937549741584: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[06:26:38.785] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1611123995810988",
"created_by": "project:chromium",
"created_ts": "1611117151650539",
"id": "8857614937549741584",
"parameters_json": "{\"builder_name\": \"linux-chromeos-dbg\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"abb0ef991720bf5394a20f5cf77270ce923b72c9\"}}",
"project": "chromium",
"result": "SUCCESS",
"result_details_json": "{\"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\": \"abb0ef991720bf5394a20f5cf77270ce923b72c9\", \"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-86-wu7l\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.chromiumos\", \"buildername\": \"linux-chromeos-dbg\", \"buildnumber\": 22266, \"got_angle_revision\": \"2e0490eedcc809bcd6359de6afdb9e40bd9f731a\", \"got_dawn_revision\": \"4b316994ad01ab6b87032c5fd9b53c6d18956d8d\", \"got_nacl_revision\": \"cb31feffa500401c95c6c44d88b7c358236bca36\", \"got_revision\": \"abb0ef991720bf5394a20f5cf77270ce923b72c9\", \"got_revision_cp\": \"refs/heads/master@{#845014}\", \"got_swarming_client_revision\": \"1a072711d4388c62e02480fabc26c68c24494be9\", \"got_swiftshader_revision\": \"89fd1480b47e8c8668dfd3c24302c53b76ba4c88\", \"got_v8_revision\": \"69c461e9bd40c5c45d553d3d19bb2771e32b4d64\", \"got_v8_revision_cp\": \"refs/heads/9.0.18@{#1}\", \"got_webrtc_revision\": \"5eb527cf7fb28e22d0687c0295cb9f1bb458160c\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#33034}\", \"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\": \"abb0ef991720bf5394a20f5cf77270ce923b72c9\", \"swarm_hashes_refs/heads/master(at){#845014}_without_patch\": {\"absl_hardening_tests\": \"f507254870a66da721d776f282bac06cce775a6f\", \"accessibility_unittests\": \"6d57439d5d89f32d17c566844082b1c5dafc4393\", \"angle_unittests\": \"87b103a2ecbd1ff5d09e17c9856811e3839bc91c\", \"app_list_unittests\": \"82e212dc58035f8441027d7733d49e2bcf2392b5\", \"app_shell_unittests\": \"ff7c06bb05b342e310c2131abc20eea07e75ee12\", \"ash_unittests\": \"8bf5264ea1752262ce9c5d4418d4e3c203801bf5\", \"aura_unittests\": \"fd7c10d77716e7ad2eae9bb460e8045aa6f5c5ff\", \"base_unittests\": \"5b09fec0df9c4057813cf6e9747d13a732bd25ed\", \"base_util_unittests\": \"35aef6ceb19f3396a357c8a445cfd070cf8e09f7\", \"blink_common_unittests\": \"9df7c7fa079f0528cd21fac0a3c99bb83f9963fa\", \"blink_fuzzer_unittests\": \"ae93ab5346add6155c94266325b331341aaf044e\", \"blink_heap_unittests\": \"197e4cc8f0d483c287e7a6bb7895346199d09f8c\", \"blink_platform_unittests\": \"f4f9f40f8aa161d4a8833ecfe067abf3f1b78687\", \"blink_unittests\": \"b6ebc79aff409e009df387173df81dc200a89880\", \"boringssl_crypto_tests\": \"e63aa6b4c7f5cbc8458ea033a0591f2abd071d66\", \"boringssl_ssl_tests\": \"39cd58b84d023b7afb91f19d5707f841b0752d57\", \"browser_tests\": \"5114f204215a730ba38639952b4712a2cbf72142\", \"capture_unittests\": \"a5e61c5a28e3f64a3fb9dcfd1e0fd9bb5e9c2b1b\", \"cast_unittests\": \"092d196648acc90f3d10fd5f8c9adadac869fbfa\", \"cc_unittests\": \"a6bd80e293d74b3840a7d18eab2c569ab3d2a6cc\", \"chrome_app_unittests\": \"bd00b12f6f18b121feff81f07c7a19d57366719e\", \"chromedriver_unittests\": \"2aa2d272a147d9cdb3e768e6a76ec7020843fa96\", \"chromeos_components_unittests\": \"58d5799c9cd1ab69b327faba428727004b2d8dd4\", \"chromeos_unittests\": \"803ae62d52aa5e1e7855ebf0189c47ba2aa62665\", \"components_browsertests\": \"611124734b9795c68cc9f3d6235cafe0757c1878\", \"components_unittests\": \"0dc6508d4c56c28dc8c306537672d7e1473c011c\", \"compositor_unittests\": \"2f5051d97507708cfec4bc16194b825e3398c627\", \"content_browsertests\": \"0229e3f0ecb339f7b06ed0847feb264104c5872b\", \"content_unittests\": \"3f978023bf82a5127beeee0eefee0fcbf89c199d\", \"crashpad_tests\": \"1cb6801e3fdf3bee55646957dd21e5bfffdbb465\", \"crypto_unittests\": \"96d6979e9f18369ad034ba9d3b1341fa0fc1375d\", \"dbus_unittests\": \"9a79654461ee96f2770aaa215e284be5762ad01c\", \"device_unittests\": \"c98653eef8028650cce80f0537ab0b866b8d6bac\", \"display_unittests\": \"9a38d9f3608ba32c637c73dd468aabcc9624d8b6\", \"events_unittests\": \"569903bfebe54278860799b1880fda5cfc608685\", \"exo_unittests\": \"4327fc41ee4e4f67fc2790de47f73e977c64c630\", \"extensions_browsertests\": \"06cf7655a45586d4df1d020a78addb03581307ae\", \"extensions_unittests\": \"49522947bf5c1f2951c7c2dbba7c425c82dbce35\", \"filesystem_service_unittests\": \"b5516a03468d3e19bef64393893d742acd62030e\", \"gcm_unit_tests\": \"d0eb9d511364bd988ffeba1d99f533b507caae19\", \"gfx_unittests\": \"71ffbc75ddfb0f7bc32efcd54e284856ede056b8\", \"gin_unittests\": \"3c09ab6115ac84a2db3118be087efeca2a86d276\", \"gl_unittests_ozone\": \"f801691dd0d6ac59b64aa384a5b6126a0b4b4a4f\", \"google_apis_unittests\": \"d59e3c89e6392756e1fdfc3c55500fa80b0f3f09\", \"gpu_unittests\": \"866fcd87f436a568567be706d7a6e6e654336893\", \"gwp_asan_unittests\": \"c7a8437fe89b5fec2179176b83fc85729f74ca2d\", \"interactive_ui_tests\": \"017672ebc337319cc07a0382150516d472be9301\", \"ipc_tests\": \"8dd2cc1e9ce0cf94f016c0e2f4cce25d09943ec0\", \"jingle_unittests\": \"20f60f580f0c062d67ad33a0c33258ac9336207e\", \"keyboard_unittests\": \"0a4d520bb800589bfa68811b03e4330950d30534\", \"latency_unittests\": \"ca99cdbdcf69938989a79a146fa957736d54cd0b\", \"libjingle_xmpp_unittests\": \"3f51a210474accb00cb182b2a950534a5855118b\", \"liburlpattern_unittests\": \"cf0162613240a2dcb8563cec669e5d6e513b3c5c\", \"media_blink_unittests\": \"29b03f1f721acb2cbcbd5557264908edd40f9320\", \"media_unittests\": \"179e10492290399c7d498b2f7ab71818509cec1d\", \"message_center_unittests\": \"5c0791c87fb9f212adec32aebba45797b661cc49\", \"midi_unittests\": \"6e259027fc3e897472aa25c935c205d1f7f43d84\", \"mojo_core_unittests\": \"93bfa3357c41140bebc8215f43976b878074a8ab\", \"mojo_unittests\": \"0883c063f9f2840328e1a5860a08334d16351095\", \"nacl_helper_nonsfi_unittests\": \"27d0d7725516ff7440dca9a897b9c7e3c3b3a5f0\", \"nacl_loader_unittests\": \"a52501da2c7afa16302868011444a25fbffbae17\", \"native_theme_unittests\": \"92cf0a51e5121b2e0706534602a8597f6d260fee\", \"net_unittests\": \"1f6f55ee955d9a1f63d79f3e48a55c36ccc7b180\", \"ozone_gl_unittests\": \"4bb9a98029f28c054f1f85035d7fdc46dc940db4\", \"ozone_unittests\": \"2e230a054834d5285292096ce3d029855869a5c7\", \"ozone_x11_unittests\": \"1ba364de1162ed86863bd5b4286589bea92703f0\", \"pdf_unittests\": \"26f3c630783d33336bbc2cfd9e35110eae0614e1\", \"perfetto_unittests\": \"37a236427588a0f1320c373bae8c224bee4f77f7\", \"ppapi_unittests\": \"97cd9f41bfcee920c6d501ed132940f6248c26a1\", \"printing_unittests\": \"53e051b18f432d3eed8b7d9409fb904eb908d6a1\", \"remoting_unittests\": \"35d2fcf4917f609cb52c8df01508f9dd6860ee23\", \"sandbox_linux_unittests\": \"4acb8130c64e89793a6db26e6904966030a7e258\", \"service_manager_unittests\": \"cdd60b7b801b65c694524d4a7efa4e695f9bbace\", \"services_unittests\": \"51bfee48666f162ae1f55a1942c4270c7e1bcb07\", \"shell_dialogs_unittests\": \"92e14594c106958669f326207eb44d5302d4b01d\", \"shell_encryption_unittests\": \"6d31eaa8538792da637fca0035a1d3e899cd8d82\", \"skia_unittests\": \"1b532de65f397498a5656147eaee95c17f1097e8\", \"snapshot_unittests\": \"5df4904aab82c69267de2ae8a2718439d91b4463\", \"sql_unittests\": \"42a479e020e26e8d5260fd6969ec45f1b7c2c559\", \"storage_unittests\": \"7f283a2519bbbd847d7364f8cf99fceadd0e4f09\", \"sync_integration_tests\": \"47afe951792a4d6844896e4d9db00d81c6e36492\", \"traffic_annotation_auditor_unittests\": \"8c868e16c4d4b71d39108dc91aa2f023b584d31e\", \"ui_base_unittests\": \"7e3d543dea1636f163341e75ec831c8341c1a5a5\", \"ui_chromeos_unittests\": \"c71dd43cd39299ed3d5feb57f59c6e1e03bb989f\", \"ui_touch_selection_unittests\": \"2c1b17b6ff59541b0e5d296f8f8a590bce6d63f7\", \"unit_tests\": \"e8d68648b19f0ea4cf20d4a0134cee37000a1931\", \"url_unittests\": \"09649d9809a76fc3df65d04ef0b9c0c1463754dd\", \"usage_time_limit_unittests\": \"8a1683897f4df9a126eb8d8ff23e11824a87fb99\", \"views_unittests\": \"ca73d4a2700e09e5ab25e0919e7f151f077226bc\", \"viz_unittests\": \"6c169319fe3e9114b52570d1d773a08596ee841b\", \"wm_unittests\": \"3a9df95cf3b258dce3ae4bb24176cf9303ada79b\", \"wtf_unittests\": \"2a9fa2683879d1715a834135a512708d247b7fdd\", \"zlib_unittests\": \"20605de5845071bf4391eb184015ceedc544ddb1\"}}, \"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-central1-b-8-86-wu7l\"], \"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\": [\"5666-679c9bd\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1611117161513125",
"status": "COMPLETED",
"status_changed_ts": "1611123996522948",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-dbg/22266",
"builder:linux-chromeos-dbg",
"buildset:commit/git/abb0ef991720bf5394a20f5cf77270ce923b72c9",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/abb0ef991720bf5394a20f5cf77270ce923b72c9",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9023044999558017888",
"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/8857614937549741584/+/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:5136e265c1c2ee10",
"user_agent:luci-scheduler"
],
"updated_ts": "1611123996579987",
"url": "https://ci.chromium.org/b/8857614937549741584",
"utcnow_ts": "1611123998767390"
}
}
[06:26:38.789] Invocation finished in 1h54m8.437377339s with status SUCCEEDED