[10:55:37.187] New invocation is queued and will start shortly
[10:55:38.316] Starting the invocation (attempt 1)
[10:55:38.377] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[10:55:38.377] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[10:55:38.377] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9017947466009769648",
"parameters_json": "{\"builder_name\":\"linux-chromeos-dbg\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"0c74fc4fd85a56e052c336f980d5e177c3ad40a8\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:linux-chromeos-dbg",
"scheduler_invocation_id:9017947466009769648",
"scheduler_job_id:chromium/linux-chromeos-dbg",
"user_agent:luci-scheduler",
"buildset:commit/git/0c74fc4fd85a56e052c336f980d5e177c3ad40a8",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/0c74fc4fd85a56e052c336f980d5e177c3ad40a8",
"gitiles_ref:refs/heads/master"
]
}
[10:55:39.260] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1615978538487437",
"id": "8852517403985958416",
"parameters_json": "{\"builder_name\": \"linux-chromeos-dbg\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"0c74fc4fd85a56e052c336f980d5e177c3ad40a8\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1615978539008698",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-dbg/23019",
"builder:linux-chromeos-dbg",
"buildset:commit/git/0c74fc4fd85a56e052c336f980d5e177c3ad40a8",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/0c74fc4fd85a56e052c336f980d5e177c3ad40a8",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9017947466009769648",
"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/8852517403985958416/+/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": "1615978539008825",
"url": "https://ci.chromium.org/b/8852517403985958416",
"utcnow_ts": "1615978539210694"
}
}
[10:55:39.260] Task URL: https://ci.chromium.org/b/8852517403985958416
[10:55:39.260] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:2:0) after 1m0s
[10:55:52.447] Received PubSub notification, asking Buildbucket for the build status
[10:55:52.509] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:56:39.299] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:2:0)
[10:56:39.299] Timer tick, asking Buildbucket for the build status
[10:56:39.378] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:56:39.378] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:4:0) after 1m0s
[10:57:39.439] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:4:0)
[10:57:39.439] Timer tick, asking Buildbucket for the build status
[10:57:39.718] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:57:39.718] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:5:0) after 1m0s
[10:58:39.723] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:5:0)
[10:58:39.723] Timer tick, asking Buildbucket for the build status
[10:58:39.826] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:58:39.826] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:6:0) after 1m0s
[10:59:39.900] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:6:0)
[10:59:39.900] Timer tick, asking Buildbucket for the build status
[10:59:39.976] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:59:39.976] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:7:0) after 1m0s
[11:00:40.009] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:7:0)
[11:00:40.009] Timer tick, asking Buildbucket for the build status
[11:00:40.152] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:00:40.152] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:8:0) after 1m0s
[11:01:40.129] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:8:0)
[11:01:40.129] Timer tick, asking Buildbucket for the build status
[11:01:40.207] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:01:40.207] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:9:0) after 1m0s
[11:02:40.222] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:9:0)
[11:02:40.222] Timer tick, asking Buildbucket for the build status
[11:02:40.298] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:02:40.298] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:10:0) after 1m0s
[11:03:40.378] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:10:0)
[11:03:40.378] Timer tick, asking Buildbucket for the build status
[11:03:40.454] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:03:40.454] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:11:0) after 1m0s
[11:04:40.496] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:11:0)
[11:04:40.496] Timer tick, asking Buildbucket for the build status
[11:04:40.559] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:04:40.559] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:12:0) after 1m0s
[11:05:40.594] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:12:0)
[11:05:40.594] Timer tick, asking Buildbucket for the build status
[11:05:40.678] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:05:40.678] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:13:0) after 1m0s
[11:06:40.694] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:13:0)
[11:06:40.694] Timer tick, asking Buildbucket for the build status
[11:06:40.797] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:06:40.797] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:14:0) after 1m0s
[11:07:40.814] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:14:0)
[11:07:40.814] Timer tick, asking Buildbucket for the build status
[11:07:40.875] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:07:40.875] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:15:0) after 1m0s
[11:08:40.930] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:15:0)
[11:08:40.930] Timer tick, asking Buildbucket for the build status
[11:08:41.011] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:08:41.011] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:16:0) after 1m0s
[11:09:41.073] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:16:0)
[11:09:41.073] Timer tick, asking Buildbucket for the build status
[11:09:41.144] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:09:41.144] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:17:0) after 1m0s
[11:10:41.201] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:17:0)
[11:10:41.201] Timer tick, asking Buildbucket for the build status
[11:10:41.296] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:10:41.296] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:18:0) after 1m0s
[11:11:41.392] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:18:0)
[11:11:41.392] Timer tick, asking Buildbucket for the build status
[11:11:41.502] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:11:41.502] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:19:0) after 1m0s
[11:12:41.548] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:19:0)
[11:12:41.548] Timer tick, asking Buildbucket for the build status
[11:12:41.617] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:12:41.617] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:20:0) after 1m0s
[11:13:41.734] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:20:0)
[11:13:41.734] Timer tick, asking Buildbucket for the build status
[11:13:41.903] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:13:41.903] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:21:0) after 1m0s
[11:14:41.911] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:21:0)
[11:14:41.911] Timer tick, asking Buildbucket for the build status
[11:14:41.983] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:14:41.983] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:22:0) after 1m0s
[11:15:42.008] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:22:0)
[11:15:42.008] Timer tick, asking Buildbucket for the build status
[11:15:42.231] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:15:42.231] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:23:0) after 1m0s
[11:16:42.276] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:23:0)
[11:16:42.276] Timer tick, asking Buildbucket for the build status
[11:16:42.414] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:16:42.414] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:24:0) after 1m0s
[11:17:42.464] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:24:0)
[11:17:42.464] Timer tick, asking Buildbucket for the build status
[11:17:42.522] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:17:42.522] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:25:0) after 1m0s
[11:18:42.616] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:25:0)
[11:18:42.616] Timer tick, asking Buildbucket for the build status
[11:18:42.685] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:18:42.685] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:26:0) after 1m0s
[11:19:42.747] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:26:0)
[11:19:42.747] Timer tick, asking Buildbucket for the build status
[11:19:42.895] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:19:42.896] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:27:0) after 1m0s
[11:20:42.939] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:27:0)
[11:20:42.939] Timer tick, asking Buildbucket for the build status
[11:20:43.307] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:20:43.307] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:28:0) after 1m0s
[11:21:43.341] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:28:0)
[11:21:43.341] Timer tick, asking Buildbucket for the build status
[11:21:43.405] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:21:43.405] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:29:0) after 1m0s
[11:22:43.475] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:29:0)
[11:22:43.475] Timer tick, asking Buildbucket for the build status
[11:22:43.584] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:22:43.584] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:30:0) after 1m0s
[11:23:43.623] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:30:0)
[11:23:43.624] Timer tick, asking Buildbucket for the build status
[11:23:43.691] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:23:43.691] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:31:0) after 1m0s
[11:24:43.721] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:31:0)
[11:24:43.721] Timer tick, asking Buildbucket for the build status
[11:24:43.789] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:24:43.789] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:32:0) after 1m0s
[11:25:43.841] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:32:0)
[11:25:43.841] Timer tick, asking Buildbucket for the build status
[11:25:43.923] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:25:43.923] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:33:0) after 1m0s
[11:26:43.941] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:33:0)
[11:26:43.941] Timer tick, asking Buildbucket for the build status
[11:26:44.014] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:26:44.014] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:34:0) after 1m0s
[11:27:44.032] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:34:0)
[11:27:44.032] Timer tick, asking Buildbucket for the build status
[11:27:44.099] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:27:44.099] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:35:0) after 1m0s
[11:28:44.128] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:35:0)
[11:28:44.128] Timer tick, asking Buildbucket for the build status
[11:28:44.189] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:28:44.189] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:36:0) after 1m0s
[11:29:44.209] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:36:0)
[11:29:44.209] Timer tick, asking Buildbucket for the build status
[11:29:44.463] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:29:44.463] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:37:0) after 1m0s
[11:30:44.451] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:37:0)
[11:30:44.451] Timer tick, asking Buildbucket for the build status
[11:30:44.527] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:30:44.527] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:38:0) after 1m0s
[11:31:44.580] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:38:0)
[11:31:44.580] Timer tick, asking Buildbucket for the build status
[11:31:44.639] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:31:44.639] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:39:0) after 1m0s
[11:32:44.727] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:39:0)
[11:32:44.727] Timer tick, asking Buildbucket for the build status
[11:32:44.783] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:32:44.783] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:40:0) after 1m0s
[11:33:44.898] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:40:0)
[11:33:44.898] Timer tick, asking Buildbucket for the build status
[11:33:45.358] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:33:45.358] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:41:0) after 1m0s
[11:34:45.482] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:41:0)
[11:34:45.482] Timer tick, asking Buildbucket for the build status
[11:34:45.543] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:34:45.543] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:42:0) after 1m0s
[11:35:45.606] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:42:0)
[11:35:45.606] Timer tick, asking Buildbucket for the build status
[11:35:45.677] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:35:45.677] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:43:0) after 1m0s
[11:36:45.757] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:43:0)
[11:36:45.757] Timer tick, asking Buildbucket for the build status
[11:36:45.813] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:36:45.813] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:44:0) after 1m0s
[11:37:45.806] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:44:0)
[11:37:45.806] Timer tick, asking Buildbucket for the build status
[11:37:45.956] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:37:45.956] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:45:0) after 1m0s
[11:38:45.955] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:45:0)
[11:38:45.955] Timer tick, asking Buildbucket for the build status
[11:38:46.127] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:38:46.127] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:46:0) after 1m0s
[11:39:46.167] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:46:0)
[11:39:46.167] Timer tick, asking Buildbucket for the build status
[11:39:46.539] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:39:46.539] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:47:0) after 1m0s
[11:40:46.591] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:47:0)
[11:40:46.591] Timer tick, asking Buildbucket for the build status
[11:40:46.683] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:40:46.683] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:48:0) after 1m0s
[11:41:46.708] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:48:0)
[11:41:46.709] Timer tick, asking Buildbucket for the build status
[11:41:46.772] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:41:46.772] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:49:0) after 1m0s
[11:42:46.794] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:49:0)
[11:42:46.794] Timer tick, asking Buildbucket for the build status
[11:42:47.016] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:42:47.016] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:50:0) after 1m0s
[11:43:47.075] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:50:0)
[11:43:47.075] Timer tick, asking Buildbucket for the build status
[11:43:47.151] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:43:47.151] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:51:0) after 1m0s
[11:44:47.168] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:51:0)
[11:44:47.168] Timer tick, asking Buildbucket for the build status
[11:44:47.612] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:44:47.612] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:52:0) after 1m0s
[11:45:47.707] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:52:0)
[11:45:47.707] Timer tick, asking Buildbucket for the build status
[11:45:47.806] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:45:47.806] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:53:0) after 1m0s
[11:46:47.838] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:53:0)
[11:46:47.838] Timer tick, asking Buildbucket for the build status
[11:46:47.934] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:46:47.934] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:54:0) after 1m0s
[11:47:47.913] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:54:0)
[11:47:47.913] Timer tick, asking Buildbucket for the build status
[11:47:48.227] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:47:48.227] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:55:0) after 1m0s
[11:48:48.242] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:55:0)
[11:48:48.242] Timer tick, asking Buildbucket for the build status
[11:48:48.332] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:48:48.332] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:56:0) after 1m0s
[11:49:48.335] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:56:0)
[11:49:48.335] Timer tick, asking Buildbucket for the build status
[11:49:48.530] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:49:48.530] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:57:0) after 1m0s
[11:50:48.583] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:57:0)
[11:50:48.583] Timer tick, asking Buildbucket for the build status
[11:50:48.666] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:50:48.666] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:58:0) after 1m0s
[11:51:48.748] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:58:0)
[11:51:48.748] Timer tick, asking Buildbucket for the build status
[11:51:48.829] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:51:48.829] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:59:0) after 1m0s
[11:52:48.877] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:59:0)
[11:52:48.877] Timer tick, asking Buildbucket for the build status
[11:52:49.440] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:52:49.440] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:60:0) after 1m0s
[11:53:49.515] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:60:0)
[11:53:49.515] Timer tick, asking Buildbucket for the build status
[11:53:55.594] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:53:55.594] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:61:0) after 1m0s
[11:54:55.597] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:61:0)
[11:54:55.597] Timer tick, asking Buildbucket for the build status
[11:54:55.671] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:54:55.671] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:62:0) after 1m0s
[11:55:55.746] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:62:0)
[11:55:55.746] Timer tick, asking Buildbucket for the build status
[11:55:55.837] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:55:55.837] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:63:0) after 1m0s
[11:56:55.880] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:63:0)
[11:56:55.880] Timer tick, asking Buildbucket for the build status
[11:56:55.955] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:56:55.955] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:64:0) after 1m0s
[11:57:55.950] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:64:0)
[11:57:55.950] Timer tick, asking Buildbucket for the build status
[11:57:56.070] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:57:56.070] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:65:0) after 1m0s
[11:58:56.098] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:65:0)
[11:58:56.098] Timer tick, asking Buildbucket for the build status
[11:58:56.287] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:58:56.287] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:66:0) after 1m0s
[11:59:56.338] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:66:0)
[11:59:56.338] Timer tick, asking Buildbucket for the build status
[11:59:56.723] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:59:56.723] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:67:0) after 1m0s
[12:00:56.762] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:67:0)
[12:00:56.762] Timer tick, asking Buildbucket for the build status
[12:00:56.853] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:00:56.853] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:68:0) after 1m0s
[12:01:56.910] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:68:0)
[12:01:56.911] Timer tick, asking Buildbucket for the build status
[12:01:57.104] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:01:57.104] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:69:0) after 1m0s
[12:02:57.171] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:69:0)
[12:02:57.171] Timer tick, asking Buildbucket for the build status
[12:02:57.339] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:02:57.340] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:70:0) after 1m0s
[12:03:57.380] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:70:0)
[12:03:57.380] Timer tick, asking Buildbucket for the build status
[12:03:57.454] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:03:57.454] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:71:0) after 1m0s
[12:04:57.567] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:71:0)
[12:04:57.567] Timer tick, asking Buildbucket for the build status
[12:04:57.883] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:04:57.883] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:72:0) after 1m0s
[12:05:57.913] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:72:0)
[12:05:57.913] Timer tick, asking Buildbucket for the build status
[12:05:58.348] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:05:58.348] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:73:0) after 1m0s
[12:06:58.379] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:73:0)
[12:06:58.379] Timer tick, asking Buildbucket for the build status
[12:06:58.461] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:06:58.461] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:74:0) after 1m0s
[12:07:58.493] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:74:0)
[12:07:58.493] Timer tick, asking Buildbucket for the build status
[12:07:58.624] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:07:58.624] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:75:0) after 1m0s
[12:08:58.699] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:75:0)
[12:08:58.699] Timer tick, asking Buildbucket for the build status
[12:08:58.781] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:08:58.781] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:76:0) after 1m0s
[12:09:58.823] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:76:0)
[12:09:58.823] Timer tick, asking Buildbucket for the build status
[12:09:58.921] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:09:58.921] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:77:0) after 1m0s
[12:10:58.951] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:77:0)
[12:10:58.951] Timer tick, asking Buildbucket for the build status
[12:10:59.068] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:10:59.068] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:78:0) after 1m0s
[12:11:59.107] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:78:0)
[12:11:59.107] Timer tick, asking Buildbucket for the build status
[12:11:59.818] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:11:59.818] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:79:0) after 1m0s
[12:12:59.875] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:79:0)
[12:12:59.875] Timer tick, asking Buildbucket for the build status
[12:13:00.076] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:13:00.076] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:80:0) after 1m0s
[12:14:00.096] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:80:0)
[12:14:00.096] Timer tick, asking Buildbucket for the build status
[12:14:00.195] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:14:00.195] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:81:0) after 1m0s
[12:15:00.258] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:81:0)
[12:15:00.258] Timer tick, asking Buildbucket for the build status
[12:15:00.334] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:15:00.334] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:82:0) after 1m0s
[12:16:00.380] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:82:0)
[12:16:00.380] Timer tick, asking Buildbucket for the build status
[12:16:00.491] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:16:00.491] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:83:0) after 1m0s
[12:17:00.563] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:83:0)
[12:17:00.563] Timer tick, asking Buildbucket for the build status
[12:17:00.835] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:17:00.835] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:84:0) after 1m0s
[12:18:00.858] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:84:0)
[12:18:00.858] Timer tick, asking Buildbucket for the build status
[12:18:00.975] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:18:00.975] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:85:0) after 1m0s
[12:19:01.047] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:85:0)
[12:19:01.047] Timer tick, asking Buildbucket for the build status
[12:19:01.117] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:19:01.117] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:86:0) after 1m0s
[12:20:01.162] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:86:0)
[12:20:01.162] Timer tick, asking Buildbucket for the build status
[12:20:01.237] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:20:01.237] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:87:0) after 1m0s
[12:21:01.238] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:87:0)
[12:21:01.238] Timer tick, asking Buildbucket for the build status
[12:21:01.337] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:21:01.337] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:88:0) after 1m0s
[12:22:01.387] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:88:0)
[12:22:01.387] Timer tick, asking Buildbucket for the build status
[12:22:01.476] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:22:01.476] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:89:0) after 1m0s
[12:23:01.541] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:89:0)
[12:23:01.541] Timer tick, asking Buildbucket for the build status
[12:23:01.616] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:23:01.616] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:90:0) after 1m0s
[12:24:01.639] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:90:0)
[12:24:01.639] Timer tick, asking Buildbucket for the build status
[12:24:02.011] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:24:02.011] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:91:0) after 1m0s
[12:25:02.105] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:91:0)
[12:25:02.105] Timer tick, asking Buildbucket for the build status
[12:25:02.189] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:25:02.189] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:92:0) after 1m0s
[12:26:02.242] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:92:0)
[12:26:02.242] Timer tick, asking Buildbucket for the build status
[12:26:02.462] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:26:02.462] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:93:0) after 1m0s
[12:27:02.460] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:93:0)
[12:27:02.461] Timer tick, asking Buildbucket for the build status
[12:27:02.532] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:27:02.532] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:94:0) after 1m0s
[12:28:02.540] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:94:0)
[12:28:02.540] Timer tick, asking Buildbucket for the build status
[12:28:02.651] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:28:02.651] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:95:0) after 1m0s
[12:29:02.732] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:95:0)
[12:29:02.732] Timer tick, asking Buildbucket for the build status
[12:29:02.809] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:29:02.809] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:96:0) after 1m0s
[12:30:02.947] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:96:0)
[12:30:02.947] Timer tick, asking Buildbucket for the build status
[12:30:03.119] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:30:03.119] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:97:0) after 1m0s
[12:31:03.277] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:97:0)
[12:31:03.277] Timer tick, asking Buildbucket for the build status
[12:31:03.384] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:31:03.384] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:98:0) after 1m0s
[12:32:03.416] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:98:0)
[12:32:03.416] Timer tick, asking Buildbucket for the build status
[12:32:03.550] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:32:03.550] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:99:0) after 1m0s
[12:33:03.605] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:99:0)
[12:33:03.605] Timer tick, asking Buildbucket for the build status
[12:33:03.709] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:33:03.709] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:100:0) after 1m0s
[12:34:03.760] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:100:0)
[12:34:03.760] Timer tick, asking Buildbucket for the build status
[12:34:03.842] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:34:03.842] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:101:0) after 1m0s
[12:35:03.959] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:101:0)
[12:35:03.959] Timer tick, asking Buildbucket for the build status
[12:35:04.056] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:35:04.056] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:102:0) after 1m0s
[12:36:04.077] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:102:0)
[12:36:04.077] Timer tick, asking Buildbucket for the build status
[12:36:04.645] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:36:04.645] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:103:0) after 1m0s
[12:37:04.833] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:103:0)
[12:37:04.833] Timer tick, asking Buildbucket for the build status
[12:37:04.910] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:37:04.910] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:104:0) after 1m0s
[12:38:05.007] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:104:0)
[12:38:05.007] Timer tick, asking Buildbucket for the build status
[12:38:05.153] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:38:05.153] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:105:0) after 1m0s
[12:39:05.192] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:105:0)
[12:39:05.192] Timer tick, asking Buildbucket for the build status
[12:39:05.276] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:39:05.276] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:106:0) after 1m0s
[12:40:05.303] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:106:0)
[12:40:05.303] Timer tick, asking Buildbucket for the build status
[12:40:05.422] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:40:05.422] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:107:0) after 1m0s
[12:41:05.500] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:107:0)
[12:41:05.500] Timer tick, asking Buildbucket for the build status
[12:41:05.590] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:41:05.590] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:108:0) after 1m0s
[12:42:05.621] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:108:0)
[12:42:05.621] Timer tick, asking Buildbucket for the build status
[12:42:05.924] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:42:05.924] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:109:0) after 1m0s
[12:43:05.963] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:109:0)
[12:43:05.963] Timer tick, asking Buildbucket for the build status
[12:43:06.245] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:43:06.245] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:110:0) after 1m0s
[12:44:06.268] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:110:0)
[12:44:06.268] Timer tick, asking Buildbucket for the build status
[12:44:06.485] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:44:06.485] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:111:0) after 1m0s
[12:45:06.555] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:111:0)
[12:45:06.555] Timer tick, asking Buildbucket for the build status
[12:45:07.117] Build 8852517403985958416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:45:07.117] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9017947466009769648:112:0) after 1m0s
[12:45:53.994] Received PubSub notification, asking Buildbucket for the build status
[12:45:54.086] Build 8852517403985958416: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[12:45:54.086] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1615985152724463",
"created_by": "project:chromium",
"created_ts": "1615978538487437",
"id": "8852517403985958416",
"parameters_json": "{\"builder_name\": \"linux-chromeos-dbg\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"0c74fc4fd85a56e052c336f980d5e177c3ad40a8\"}}",
"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\": \"0c74fc4fd85a56e052c336f980d5e177c3ad40a8\", \"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-117-fu34\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.chromiumos\", \"buildername\": \"linux-chromeos-dbg\", \"buildnumber\": 23019, \"got_angle_revision\": \"27e12398b33894bf345dc8c496d0bcde527f9892\", \"got_dawn_revision\": \"ed16517e32ce29c64abc05b19c0ea31671c8b053\", \"got_nacl_revision\": \"abf3277f295c6c87f0b103f291ed5e3e73933b76\", \"got_revision\": \"0c74fc4fd85a56e052c336f980d5e177c3ad40a8\", \"got_revision_cp\": \"refs/heads/master@{#863699}\", \"got_swarming_client_revision\": \"a32a1607f6093d338f756c7e7c7b4333b0c50c9c\", \"got_swiftshader_revision\": \"a98fb3f8380a3a5c9ae3e0175634ba88c85a434f\", \"got_v8_revision\": \"c47dfc8ab1b8c17a6959f42e069091a38e72c040\", \"got_v8_revision_cp\": \"refs/heads/9.1.140@{#1}\", \"got_webrtc_revision\": \"ab6335041130fdc0365a604f49668eac9194f9d6\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#33479}\", \"is_cached\": true, \"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\": \"0c74fc4fd85a56e052c336f980d5e177c3ad40a8\", \"swarm_hashes_refs/heads/master(at){#863699}_without_patch\": {\"absl_hardening_tests\": \"36f2fdf64b11579a15bdda9e2389578306516d68\", \"accessibility_unittests\": \"2bfbb316d5807190b4a3271274ebb12055a4ec3c\", \"angle_unittests\": \"5720ddc2bf0f2811aa2b73bb9978b252af7d40e6\", \"app_list_unittests\": \"86f9794b5cc792db2451b6970dcb682667e71383\", \"app_shell_unittests\": \"e91153b25d9a2d0f41adaad5c3cddc2d3ae81469\", \"ash_unittests\": \"7c15cbab87896152769c0dfdf82b7d9b4e4535ca\", \"aura_unittests\": \"8c6fc13a698335363af1269b269d0706d4d77f47\", \"base_unittests\": \"9311f826316ebbdc5fea468f4d778ea40ea2e3ee\", \"base_util_unittests\": \"58fe7f0ab32a3a6b409c890df9d7fe31c501e898\", \"blink_common_unittests\": \"be0eceba0dbbdb582eaa13043c405485577b0b49\", \"blink_fuzzer_unittests\": \"f7839ab4f0e7bf38cbce16a1328bc726a31ab86a\", \"blink_heap_unittests\": \"673ee3b52c4919861bc9ad52f6d9b6f30e86b4d7\", \"blink_platform_unittests\": \"02a6cfbd32070f757e01fa100e04ca940ab35f1f\", \"blink_unittests\": \"08bde2854f0348fa9e71ac0af1e992acb6595829\", \"boringssl_crypto_tests\": \"be138030444961979a2da532ef07f3ad4918ee23\", \"boringssl_ssl_tests\": \"e5431b90d1ac68d09fb0f18d3fd610b9f32325e5\", \"browser_tests\": \"0a2988cd8ae65bafd0810e64a2ac48a5b18a29a3\", \"capture_unittests\": \"c0398e1161e03d051a9300f4c6a8f2321a4b2440\", \"cast_unittests\": \"e9864bf026819f14c5d214e8d59ab2d89aa60924\", \"cc_unittests\": \"ee6e76d1ccca2caa336312bf25a8646114502d27\", \"chrome_app_unittests\": \"db2b7e346ac02949d449362f53e508903078c726\", \"chromedriver_unittests\": \"b71b00bd9adc25dff180827a3e9cf9fe5c2b1723\", \"chromeos_components_unittests\": \"3c1b14acd7fa9e0cabfb0187cde6abd0e5465978\", \"chromeos_unittests\": \"db67e3c8ba9b638adfb6220bae7215dc415e317d\", \"color_unittests\": \"a5b249345169f38d7d846c4c207ebb9945d3ea54\", \"components_browsertests\": \"4f2728005e895beb2e33d4169995c75e1ad1f990\", \"components_unittests\": \"42e7e16e933af61154e337598f54b14ec0ac6d7e\", \"compositor_unittests\": \"666a4b4b8778a20c2f6638fb242c76ded49c5c38\", \"content_browsertests\": \"112c4b3ac212bac88b2d52cfbd0c0237fc0930c9\", \"content_unittests\": \"df2e70f70fbf4eb2745e05d63972b86f6e2fe2a1\", \"crashpad_tests\": \"db504df8bc6cd916f9c86d8c5fed877179c1cd3d\", \"crypto_unittests\": \"1e7cfac637a5623b4357817daf99e37f989bd609\", \"dbus_unittests\": \"afa5b85f98bd10076d7ca2950606750d0b9b9ad1\", \"device_unittests\": \"b6205b2ba00676a4fc1f5b2c0549e1efb0547bd5\", \"display_unittests\": \"cb7d0a695c75f040763e71d5327335480cf9b683\", \"events_unittests\": \"49c2af1412fb22cfb0fe839d3d2c500d098c540a\", \"exo_unittests\": \"65bc888b50cd1897e2c8f2aab7842800a410deb5\", \"extensions_browsertests\": \"1e1f47655ac61f36c2042e1238309abf56f6783c\", \"extensions_unittests\": \"c49c27a8b4424d11f0af1968f84441d19ec12a5d\", \"filesystem_service_unittests\": \"cfc732f9a9a60fd3345582390e4cc3cfa3fc0694\", \"gcm_unit_tests\": \"3af04f5ac2a739d927544169d5b84fc323768457\", \"gfx_unittests\": \"823b06c731566165ab6b6617d070e2893bab4b84\", \"gin_unittests\": \"3b2c00870cceae26b45f2b8b18a928ca273cdbd7\", \"gl_unittests_ozone\": \"abef477e4d5154a7c2633618a0aae54ea22b623b\", \"google_apis_unittests\": \"8f05f651c0d838371e8f31878396476633417d8c\", \"gpu_unittests\": \"a8f5f46066aa2a53a3a8e6860cb55296ede02f75\", \"gwp_asan_unittests\": \"e137a1404406e1c095510bbfefff11f1b4b19878\", \"interactive_ui_tests\": \"3bf9f8a735d0797701a6b80cfcb1cc94a6068bfc\", \"ipc_tests\": \"20f2e051a312a6da0f2a3876584ab214a8fcfa4b\", \"jingle_unittests\": \"df49377caade16db8cfd5ebe90d9cb5b481a157c\", \"keyboard_unittests\": \"5ac41c524905da41824acd78a447259bcd82204e\", \"latency_unittests\": \"b618269d945da55887e34295d414820793e670da\", \"libjingle_xmpp_unittests\": \"4e1f5e4a4582650678b7922b932f8e35f2d6b8e4\", \"liburlpattern_unittests\": \"99c9bc5df9d13ae28c11ef213aa96a76126c7520\", \"media_blink_unittests\": \"b3793180a904ed41ab0f655236e8e1b2094ac281\", \"media_unittests\": \"2df9c2fddbb889a08b10d92b1fa5df303918014b\", \"message_center_unittests\": \"d6162e065fc4a35c7623cae4581e00f008fd7e70\", \"midi_unittests\": \"c0163ac7aa1d639fadcf187d80b50f52c89ebfc4\", \"mojo_core_unittests\": \"a8c128dd54649c979537430a18967a64b8c5416f\", \"mojo_unittests\": \"fd43dd7e42cf666515e396152aa3887d99ea685d\", \"nacl_helper_nonsfi_unittests\": \"ca4a0a18ec4632b101a75168ae0d599fb511e354\", \"nacl_loader_unittests\": \"dfac7c6a9047661a547cd3addfb24d5aaaa833e3\", \"native_theme_unittests\": \"345f6b068a1203484198f704ff3d634e619e2d06\", \"net_unittests\": \"a1afec88264bfc4e3543f4a5f046b364b48e1d1b\", \"ozone_gl_unittests\": \"73a40e7fc1c3a77169d06415f9d55067c750a957\", \"ozone_unittests\": \"3570c06d3a61c4a8d79deaf7e472a619ed17e551\", \"ozone_x11_unittests\": \"9febfc4b8f96c3db1b0c6f639710283225da31d1\", \"pdf_unittests\": \"f654177f0b662b85f7cf915aee529cf405552c34\", \"perfetto_unittests\": \"35986eefa869d6b88a46f618d52d4d6dc02bbd5c\", \"ppapi_unittests\": \"b6462e1b42035496dc1182aa1c917033d16d9972\", \"printing_unittests\": \"5044be231c3226fc64fe06fd8a3b7a986c1f7791\", \"remoting_unittests\": \"daf9398944df9453afb6398548f95ea7c367407f\", \"sandbox_linux_unittests\": \"f7b81d841c4af350319db73477309b079fd61e8e\", \"service_manager_unittests\": \"eb8d9527d411d31a9a7519b9ddf0632f4e2755f2\", \"services_unittests\": \"9f47689a65b670f408f77e1094aec4c522d76b2d\", \"shell_dialogs_unittests\": \"3a1da5600427c2ce09d70de5d486694ae29ea58e\", \"shell_encryption_unittests\": \"62e46ba53d9db046876b4b42b39116bc6f3584a3\", \"skia_unittests\": \"9f5cf861e71726e372a94bed924b8a726dd794a5\", \"snapshot_unittests\": \"759f5734d24ece7852a7b3dddcbf66c79629226b\", \"sql_unittests\": \"310172d2325b279e38611d5a22a70815a6f2e1a6\", \"storage_unittests\": \"0a7ee5b6d7de34c310ceb4837d286865dc34d8e1\", \"sync_integration_tests\": \"5713f464c81053827ba83346005255b5611e2d5c\", \"traffic_annotation_auditor_unittests\": \"8b1a61b93b186ee2ec95251c37cc1b7685c7361e\", \"ui_base_unittests\": \"408d31651df195a8512facc7ba361e951d86ca8e\", \"ui_chromeos_unittests\": \"a288736062195a34c3d87ca3e85b3908bc402ac0\", \"ui_touch_selection_unittests\": \"d93716fbc9c8aebdcacbb0dae500cf66582c4ce6\", \"unit_tests\": \"dcc2e5cb07296b6268e3767ac968f6dc27982c28\", \"url_unittests\": \"300c15fab279a24e60da549f517edbd2347063e5\", \"usage_time_limit_unittests\": \"f56f3f7b6eed1f3e99a472a3f13dbc2da0ea96f5\", \"views_unittests\": \"d7cae691baa50f167c5162129559dcf97f2a0ce8\", \"viz_unittests\": \"f5318ba18d23554027eb6e5afd88caf65741fbea\", \"wayland_client_tests\": \"5812ef21778f9936b9f036f00b913135397f51f8\", \"wm_unittests\": \"82c3fb1586b490de4d759decf5931b6107b6e8de\", \"wtf_unittests\": \"154d95d5c2713d2c5756d0b0b004b0c96ca2b1d1\", \"zlib_unittests\": \"4f9f689e1adfe0ed7cc46a4a0abb65b688efc8b6\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_4973d939604d11dcbaec68575e69c80c756ff63e355ab013b29b8bca26434b7c_v2\", \"builder_4a2b13219f689d34aa475139e9738b55334bf25923df6aa4978f2ee96f164d56_v2\", \"builder_5018db700e530f8e7ae860b5b3feab2b02d3dedf1bbd3e704c6c59fde1b308dd_v2\", \"builder_abe2adbd32ad911c3e8d1f384e915329cf1f65e427edb6b91a9fbb61a55ed743_v2\", \"builder_fa0031875b7f2f11c46443055ab400bfaeb07a1d2a142b58c631314016c04e0a_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-117-fu34\"], \"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\": [\"5754-8c4f760\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1615978551605022",
"status": "COMPLETED",
"status_changed_ts": "1615985153124269",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-dbg/23019",
"builder:linux-chromeos-dbg",
"buildset:commit/git/0c74fc4fd85a56e052c336f980d5e177c3ad40a8",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/0c74fc4fd85a56e052c336f980d5e177c3ad40a8",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9017947466009769648",
"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/8852517403985958416/+/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:5258a53142506a10",
"user_agent:luci-scheduler"
],
"updated_ts": "1615985153129656",
"url": "https://ci.chromium.org/b/8852517403985958416",
"utcnow_ts": "1615985154077470"
}
}
[12:45:54.086] Invocation finished in 1h50m16.913875057s with status SUCCEEDED