[16:58:27.022] New invocation is queued and will start shortly
[16:58:28.180] Starting the invocation (attempt 1)
[16:58:28.220] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[16:58:28.220] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[16:58:28.220] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9030427020052725712",
"parameters_json": "{\"builder_name\":\"linux-chromeos-dbg\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"940811014dc2880958d172cf05449c47a58cbb4e\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:linux-chromeos-dbg",
"scheduler_invocation_id:9030427020052725712",
"scheduler_job_id:chromium/linux-chromeos-dbg",
"user_agent:luci-scheduler",
"buildset:commit/git/940811014dc2880958d172cf05449c47a58cbb4e",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/940811014dc2880958d172cf05449c47a58cbb4e",
"gitiles_ref:refs/heads/master"
]
}
[16:58:28.825] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1604077108313178",
"id": "8864996958031787776",
"parameters_json": "{\"builder_name\": \"linux-chromeos-dbg\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"940811014dc2880958d172cf05449c47a58cbb4e\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1604077108679884",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-dbg/21077",
"builder:linux-chromeos-dbg",
"buildset:commit/git/940811014dc2880958d172cf05449c47a58cbb4e",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/940811014dc2880958d172cf05449c47a58cbb4e",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9030427020052725712",
"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/8864996958031787776/+/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": "1604077108679994",
"url": "https://ci.chromium.org/b/8864996958031787776",
"utcnow_ts": "1604077108817876"
}
}
[16:58:28.825] Task URL: https://ci.chromium.org/b/8864996958031787776
[16:58:28.825] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:2:0) after 1m0s
[16:59:29.082] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:2:0)
[16:59:29.082] Timer tick, asking Buildbucket for the build status
[16:59:29.261] Build 8864996958031787776: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[16:59:29.261] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:3:0) after 1m0s
[17:00:29.282] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:3:0)
[17:00:29.282] Timer tick, asking Buildbucket for the build status
[17:00:29.703] Build 8864996958031787776: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[17:00:29.703] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:4:0) after 1m0s
[17:01:29.794] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:4:0)
[17:01:29.794] Timer tick, asking Buildbucket for the build status
[17:01:29.953] Build 8864996958031787776: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[17:01:29.953] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:5:0) after 1m0s
[17:02:30.024] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:5:0)
[17:02:30.024] Timer tick, asking Buildbucket for the build status
[17:02:30.379] Build 8864996958031787776: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[17:02:30.379] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:6:0) after 1m0s
[17:03:11.552] Received PubSub notification, asking Buildbucket for the build status
[17:03:11.823] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:03:30.586] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:6:0)
[17:03:30.586] Timer tick, asking Buildbucket for the build status
[17:03:30.883] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:03:30.883] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:8:0) after 1m0s
[17:04:30.970] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:8:0)
[17:04:30.970] Timer tick, asking Buildbucket for the build status
[17:04:31.269] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:04:31.269] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:9:0) after 1m0s
[17:05:31.413] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:9:0)
[17:05:31.413] Timer tick, asking Buildbucket for the build status
[17:05:31.695] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:05:31.695] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:10:0) after 1m0s
[17:06:31.737] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:10:0)
[17:06:31.737] Timer tick, asking Buildbucket for the build status
[17:06:32.000] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:06:32.000] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:11:0) after 1m0s
[17:07:32.024] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:11:0)
[17:07:32.024] Timer tick, asking Buildbucket for the build status
[17:07:32.163] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:07:32.163] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:12:0) after 1m0s
[17:08:32.191] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:12:0)
[17:08:32.191] Timer tick, asking Buildbucket for the build status
[17:08:32.334] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:08:32.334] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:13:0) after 1m0s
[17:09:32.404] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:13:0)
[17:09:32.404] Timer tick, asking Buildbucket for the build status
[17:09:33.110] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:09:33.110] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:14:0) after 1m0s
[17:10:33.132] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:14:0)
[17:10:33.132] Timer tick, asking Buildbucket for the build status
[17:10:33.485] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:10:33.485] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:15:0) after 1m0s
[17:11:33.489] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:15:0)
[17:11:33.489] Timer tick, asking Buildbucket for the build status
[17:11:33.939] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:11:33.939] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:16:0) after 1m0s
[17:12:34.023] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:16:0)
[17:12:34.023] Timer tick, asking Buildbucket for the build status
[17:12:34.195] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:12:34.195] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:17:0) after 1m0s
[17:13:34.248] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:17:0)
[17:13:34.248] Timer tick, asking Buildbucket for the build status
[17:13:34.366] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:13:34.366] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:18:0) after 1m0s
[17:14:34.484] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:18:0)
[17:14:34.484] Timer tick, asking Buildbucket for the build status
[17:14:34.872] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:14:34.872] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:19:0) after 1m0s
[17:15:34.899] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:19:0)
[17:15:34.899] Timer tick, asking Buildbucket for the build status
[17:15:34.986] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:15:34.986] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:20:0) after 1m0s
[17:16:35.006] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:20:0)
[17:16:35.006] Timer tick, asking Buildbucket for the build status
[17:16:36.241] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:16:36.241] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:21:0) after 1m0s
[17:17:36.336] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:21:0)
[17:17:36.336] Timer tick, asking Buildbucket for the build status
[17:17:36.407] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:17:36.407] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:22:0) after 1m0s
[17:18:36.539] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:22:0)
[17:18:36.539] Timer tick, asking Buildbucket for the build status
[17:18:36.727] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:18:36.727] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:23:0) after 1m0s
[17:19:36.780] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:23:0)
[17:19:36.780] Timer tick, asking Buildbucket for the build status
[17:19:36.975] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:19:36.975] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:24:0) after 1m0s
[17:20:37.008] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:24:0)
[17:20:37.008] Timer tick, asking Buildbucket for the build status
[17:20:37.112] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:20:37.112] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:25:0) after 1m0s
[17:21:37.167] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:25:0)
[17:21:37.167] Timer tick, asking Buildbucket for the build status
[17:21:37.382] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:21:37.382] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:26:0) after 1m0s
[17:22:37.442] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:26:0)
[17:22:37.442] Timer tick, asking Buildbucket for the build status
[17:22:37.777] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:22:37.777] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:27:0) after 1m0s
[17:23:37.847] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:27:0)
[17:23:37.847] Timer tick, asking Buildbucket for the build status
[17:23:37.954] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:23:37.954] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:28:0) after 1m0s
[17:24:38.080] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:28:0)
[17:24:38.080] Timer tick, asking Buildbucket for the build status
[17:24:38.174] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:24:38.174] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:29:0) after 1m0s
[17:25:38.229] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:29:0)
[17:25:38.229] Timer tick, asking Buildbucket for the build status
[17:25:38.590] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:25:38.590] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:30:0) after 1m0s
[17:26:38.650] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:30:0)
[17:26:38.650] Timer tick, asking Buildbucket for the build status
[17:26:38.726] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:26:38.726] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:31:0) after 1m0s
[17:27:38.749] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:31:0)
[17:27:38.749] Timer tick, asking Buildbucket for the build status
[17:27:38.833] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:27:38.833] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:32:0) after 1m0s
[17:28:38.856] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:32:0)
[17:28:38.856] Timer tick, asking Buildbucket for the build status
[17:28:39.278] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:28:39.278] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:33:0) after 1m0s
[17:29:39.297] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:33:0)
[17:29:39.297] Timer tick, asking Buildbucket for the build status
[17:29:39.364] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:29:39.364] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:34:0) after 1m0s
[17:30:39.403] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:34:0)
[17:30:39.403] Timer tick, asking Buildbucket for the build status
[17:30:39.486] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:30:39.486] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:35:0) after 1m0s
[17:31:39.546] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:35:0)
[17:31:39.546] Timer tick, asking Buildbucket for the build status
[17:31:39.815] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:31:39.815] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:36:0) after 1m0s
[17:32:39.788] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:36:0)
[17:32:39.788] Timer tick, asking Buildbucket for the build status
[17:32:39.929] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:32:39.929] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:37:0) after 1m0s
[17:33:40.021] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:37:0)
[17:33:40.021] Timer tick, asking Buildbucket for the build status
[17:33:40.137] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:33:40.137] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:38:0) after 1m0s
[17:34:40.178] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:38:0)
[17:34:40.178] Timer tick, asking Buildbucket for the build status
[17:34:40.285] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:34:40.285] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:39:0) after 1m0s
[17:35:40.315] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:39:0)
[17:35:40.315] Timer tick, asking Buildbucket for the build status
[17:35:40.392] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:35:40.392] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:40:0) after 1m0s
[17:36:40.385] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:40:0)
[17:36:40.385] Timer tick, asking Buildbucket for the build status
[17:36:40.537] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:36:40.537] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:41:0) after 1m0s
[17:37:40.788] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:41:0)
[17:37:40.788] Timer tick, asking Buildbucket for the build status
[17:37:41.102] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:37:41.102] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:42:0) after 1m0s
[17:38:41.149] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:42:0)
[17:38:41.149] Timer tick, asking Buildbucket for the build status
[17:38:41.261] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:38:41.261] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:43:0) after 1m0s
[17:39:41.299] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:43:0)
[17:39:41.299] Timer tick, asking Buildbucket for the build status
[17:39:41.370] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:39:41.370] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:44:0) after 1m0s
[17:40:41.379] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:44:0)
[17:40:41.379] Timer tick, asking Buildbucket for the build status
[17:40:41.452] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:40:41.452] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:45:0) after 1m0s
[17:41:41.568] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:45:0)
[17:41:41.568] Timer tick, asking Buildbucket for the build status
[17:41:41.660] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:41:41.660] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:46:0) after 1m0s
[17:42:42.485] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:46:0)
[17:42:42.485] Timer tick, asking Buildbucket for the build status
[17:42:42.699] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:42:42.699] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:47:0) after 1m0s
[17:43:42.718] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:47:0)
[17:43:42.718] Timer tick, asking Buildbucket for the build status
[17:43:42.861] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:43:42.861] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:48:0) after 1m0s
[17:44:42.908] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:48:0)
[17:44:42.908] Timer tick, asking Buildbucket for the build status
[17:44:43.015] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:44:43.015] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:49:0) after 1m0s
[17:45:43.036] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:49:0)
[17:45:43.036] Timer tick, asking Buildbucket for the build status
[17:45:43.097] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:45:43.097] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:50:0) after 1m0s
[17:46:43.095] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:50:0)
[17:46:43.095] Timer tick, asking Buildbucket for the build status
[17:46:43.211] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:46:43.211] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:51:0) after 1m0s
[17:47:43.232] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:51:0)
[17:47:43.232] Timer tick, asking Buildbucket for the build status
[17:47:43.322] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:47:43.322] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:52:0) after 1m0s
[17:48:43.357] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:52:0)
[17:48:43.357] Timer tick, asking Buildbucket for the build status
[17:48:43.521] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:48:43.521] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:53:0) after 1m0s
[17:49:43.787] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:53:0)
[17:49:43.787] Timer tick, asking Buildbucket for the build status
[17:49:44.040] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:49:44.040] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:54:0) after 1m0s
[17:50:44.076] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:54:0)
[17:50:44.076] Timer tick, asking Buildbucket for the build status
[17:50:44.330] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:50:44.330] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:55:0) after 1m0s
[17:51:44.355] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:55:0)
[17:51:44.355] Timer tick, asking Buildbucket for the build status
[17:51:44.426] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:51:44.426] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:56:0) after 1m0s
[17:52:44.491] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:56:0)
[17:52:44.491] Timer tick, asking Buildbucket for the build status
[17:52:44.561] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:52:44.562] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:57:0) after 1m0s
[17:53:44.617] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:57:0)
[17:53:44.617] Timer tick, asking Buildbucket for the build status
[17:53:44.725] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:53:44.726] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:58:0) after 1m0s
[17:54:44.761] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:58:0)
[17:54:44.761] Timer tick, asking Buildbucket for the build status
[17:54:44.923] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:54:44.923] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:59:0) after 1m0s
[17:55:44.984] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:59:0)
[17:55:44.984] Timer tick, asking Buildbucket for the build status
[17:55:45.108] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:55:45.108] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:60:0) after 1m0s
[17:56:45.236] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:60:0)
[17:56:45.236] Timer tick, asking Buildbucket for the build status
[17:56:45.389] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:56:45.389] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:61:0) after 1m0s
[17:57:45.496] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:61:0)
[17:57:45.496] Timer tick, asking Buildbucket for the build status
[17:57:45.644] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:57:45.644] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:62:0) after 1m0s
[17:58:45.644] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:62:0)
[17:58:45.644] Timer tick, asking Buildbucket for the build status
[17:58:45.847] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:58:45.847] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:63:0) after 1m0s
[17:59:45.919] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:63:0)
[17:59:45.919] Timer tick, asking Buildbucket for the build status
[17:59:46.159] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:59:46.159] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:64:0) after 1m0s
[18:00:46.272] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:64:0)
[18:00:46.272] Timer tick, asking Buildbucket for the build status
[18:00:46.448] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:00:46.448] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:65:0) after 1m0s
[18:01:46.589] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:65:0)
[18:01:46.589] Timer tick, asking Buildbucket for the build status
[18:01:46.736] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:01:46.736] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:66:0) after 1m0s
[18:02:46.799] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:66:0)
[18:02:46.799] Timer tick, asking Buildbucket for the build status
[18:02:46.943] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:02:46.943] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:67:0) after 1m0s
[18:03:47.057] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:67:0)
[18:03:47.058] Timer tick, asking Buildbucket for the build status
[18:03:47.192] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:03:47.192] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:68:0) after 1m0s
[18:04:47.235] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:68:0)
[18:04:47.235] Timer tick, asking Buildbucket for the build status
[18:04:47.329] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:04:47.329] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:69:0) after 1m0s
[18:05:47.404] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:69:0)
[18:05:47.404] Timer tick, asking Buildbucket for the build status
[18:05:47.794] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:05:47.794] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:70:0) after 1m0s
[18:06:47.806] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:70:0)
[18:06:47.806] Timer tick, asking Buildbucket for the build status
[18:06:47.930] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:06:47.930] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:71:0) after 1m0s
[18:07:47.921] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:71:0)
[18:07:47.921] Timer tick, asking Buildbucket for the build status
[18:07:48.450] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:07:48.450] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:72:0) after 1m0s
[18:08:48.522] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:72:0)
[18:08:48.522] Timer tick, asking Buildbucket for the build status
[18:08:48.711] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:08:48.711] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:73:0) after 1m0s
[18:09:48.794] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:73:0)
[18:09:48.794] Timer tick, asking Buildbucket for the build status
[18:09:48.892] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:09:48.892] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:74:0) after 1m0s
[18:10:48.983] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:74:0)
[18:10:48.983] Timer tick, asking Buildbucket for the build status
[18:10:49.079] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:10:49.079] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:75:0) after 1m0s
[18:11:49.167] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:75:0)
[18:11:49.167] Timer tick, asking Buildbucket for the build status
[18:11:49.246] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:11:49.246] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:76:0) after 1m0s
[18:12:49.313] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:76:0)
[18:12:49.313] Timer tick, asking Buildbucket for the build status
[18:12:49.919] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:12:49.919] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:77:0) after 1m0s
[18:13:49.952] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:77:0)
[18:13:49.952] Timer tick, asking Buildbucket for the build status
[18:13:50.133] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:13:50.133] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:78:0) after 1m0s
[18:14:50.255] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:78:0)
[18:14:50.255] Timer tick, asking Buildbucket for the build status
[18:14:50.893] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:14:50.893] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:79:0) after 1m0s
[18:15:50.973] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:79:0)
[18:15:50.973] Timer tick, asking Buildbucket for the build status
[18:15:51.294] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:15:51.294] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:80:0) after 1m0s
[18:16:51.335] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:80:0)
[18:16:51.335] Timer tick, asking Buildbucket for the build status
[18:16:51.661] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:16:51.661] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:81:0) after 1m0s
[18:17:51.725] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:81:0)
[18:17:51.725] Timer tick, asking Buildbucket for the build status
[18:17:52.179] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:17:52.179] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:82:0) after 1m0s
[18:18:52.201] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:82:0)
[18:18:52.201] Timer tick, asking Buildbucket for the build status
[18:18:52.391] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:18:52.391] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:83:0) after 1m0s
[18:19:52.463] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:83:0)
[18:19:52.463] Timer tick, asking Buildbucket for the build status
[18:19:52.567] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:19:52.567] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:84:0) after 1m0s
[18:20:52.631] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:84:0)
[18:20:52.631] Timer tick, asking Buildbucket for the build status
[18:20:52.734] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:20:52.734] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:85:0) after 1m0s
[18:21:52.754] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:85:0)
[18:21:52.754] Timer tick, asking Buildbucket for the build status
[18:21:52.853] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:21:52.853] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:86:0) after 1m0s
[18:22:52.888] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:86:0)
[18:22:52.888] Timer tick, asking Buildbucket for the build status
[18:22:52.953] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:22:52.953] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:87:0) after 1m0s
[18:23:53.018] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:87:0)
[18:23:53.018] Timer tick, asking Buildbucket for the build status
[18:23:53.175] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:23:53.175] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:88:0) after 1m0s
[18:24:53.218] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:88:0)
[18:24:53.218] Timer tick, asking Buildbucket for the build status
[18:24:53.322] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:24:53.322] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:89:0) after 1m0s
[18:25:53.348] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:89:0)
[18:25:53.348] Timer tick, asking Buildbucket for the build status
[18:25:53.437] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:25:53.437] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:90:0) after 1m0s
[18:26:53.468] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:90:0)
[18:26:53.468] Timer tick, asking Buildbucket for the build status
[18:26:53.546] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:26:53.546] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:91:0) after 1m0s
[18:27:53.677] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:91:0)
[18:27:53.677] Timer tick, asking Buildbucket for the build status
[18:27:53.943] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:27:53.943] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:92:0) after 1m0s
[18:28:53.968] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:92:0)
[18:28:53.968] Timer tick, asking Buildbucket for the build status
[18:28:54.103] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:28:54.103] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:93:0) after 1m0s
[18:29:54.125] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:93:0)
[18:29:54.125] Timer tick, asking Buildbucket for the build status
[18:29:54.213] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:29:54.213] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:94:0) after 1m0s
[18:30:54.261] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:94:0)
[18:30:54.261] Timer tick, asking Buildbucket for the build status
[18:30:55.091] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:30:55.091] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:95:0) after 1m0s
[18:31:55.135] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:95:0)
[18:31:55.135] Timer tick, asking Buildbucket for the build status
[18:31:55.293] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:31:55.293] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:96:0) after 1m0s
[18:32:55.354] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:96:0)
[18:32:55.354] Timer tick, asking Buildbucket for the build status
[18:32:55.439] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:32:55.439] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:97:0) after 1m0s
[18:33:55.489] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:97:0)
[18:33:55.489] Timer tick, asking Buildbucket for the build status
[18:33:55.619] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:33:55.619] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:98:0) after 1m0s
[18:34:55.725] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:98:0)
[18:34:55.725] Timer tick, asking Buildbucket for the build status
[18:34:55.898] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:34:55.898] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:99:0) after 1m0s
[18:35:55.948] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:99:0)
[18:35:55.948] Timer tick, asking Buildbucket for the build status
[18:35:56.098] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:35:56.098] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:100:0) after 1m0s
[18:36:56.123] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:100:0)
[18:36:56.123] Timer tick, asking Buildbucket for the build status
[18:36:56.205] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:36:56.205] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:101:0) after 1m0s
[18:37:56.269] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:101:0)
[18:37:56.269] Timer tick, asking Buildbucket for the build status
[18:37:56.402] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:37:56.402] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:102:0) after 1m0s
[18:38:56.436] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:102:0)
[18:38:56.436] Timer tick, asking Buildbucket for the build status
[18:38:56.591] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:38:56.591] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:103:0) after 1m0s
[18:39:56.658] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:103:0)
[18:39:56.658] Timer tick, asking Buildbucket for the build status
[18:39:57.025] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:39:57.025] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:104:0) after 1m0s
[18:40:57.106] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:104:0)
[18:40:57.106] Timer tick, asking Buildbucket for the build status
[18:40:57.245] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:40:57.245] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:105:0) after 1m0s
[18:41:57.300] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:105:0)
[18:41:57.300] Timer tick, asking Buildbucket for the build status
[18:41:57.602] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:41:57.602] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:106:0) after 1m0s
[18:42:57.630] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:106:0)
[18:42:57.630] Timer tick, asking Buildbucket for the build status
[18:42:57.905] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:42:57.905] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:107:0) after 1m0s
[18:43:57.908] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:107:0)
[18:43:57.909] Timer tick, asking Buildbucket for the build status
[18:43:58.031] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:43:58.031] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:108:0) after 1m0s
[18:44:58.078] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:108:0)
[18:44:58.078] Timer tick, asking Buildbucket for the build status
[18:44:58.168] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:44:58.168] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:109:0) after 1m0s
[18:45:58.198] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:109:0)
[18:45:58.198] Timer tick, asking Buildbucket for the build status
[18:46:00.166] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:46:00.166] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:110:0) after 1m0s
[18:47:00.246] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:110:0)
[18:47:00.246] Timer tick, asking Buildbucket for the build status
[18:47:00.331] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:47:00.332] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:111:0) after 1m0s
[18:48:00.680] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:111:0)
[18:48:00.680] Timer tick, asking Buildbucket for the build status
[18:48:00.824] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:48:00.824] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:112:0) after 1m0s
[18:49:02.004] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:112:0)
[18:49:02.004] Timer tick, asking Buildbucket for the build status
[18:49:02.173] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:49:02.173] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:113:0) after 1m0s
[18:50:02.301] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:113:0)
[18:50:02.301] Timer tick, asking Buildbucket for the build status
[18:50:02.388] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:50:02.388] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:114:0) after 1m0s
[18:51:02.551] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:114:0)
[18:51:02.553] Timer tick, asking Buildbucket for the build status
[18:51:02.807] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:51:02.807] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:115:0) after 1m0s
[18:52:03.062] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:115:0)
[18:52:03.062] Timer tick, asking Buildbucket for the build status
[18:52:03.343] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:52:03.343] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:116:0) after 1m0s
[18:53:03.439] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:116:0)
[18:53:03.439] Timer tick, asking Buildbucket for the build status
[18:53:03.597] Build 8864996958031787776: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:53:03.597] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030427020052725712:117:0) after 1m0s
[18:53:53.545] Received PubSub notification, asking Buildbucket for the build status
[18:53:53.787] Build 8864996958031787776: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[18:53:53.787] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1604084031751473",
"created_by": "project:chromium",
"created_ts": "1604077108313178",
"id": "8864996958031787776",
"parameters_json": "{\"builder_name\": \"linux-chromeos-dbg\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"940811014dc2880958d172cf05449c47a58cbb4e\"}}",
"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\": \"940811014dc2880958d172cf05449c47a58cbb4e\", \"project\": \"chromium/src\"}], \"$recipe_engine/path\": {\"cache_dir\": \"/b/s/w/ir/cache\", \"temp_dir\": \"/b/s/w/ir/tmp/rt\"}, \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"bot_id\": \"luci-chromium-ci-xenial-us-east1-d-8-8-gwu0\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.chromiumos\", \"buildername\": \"linux-chromeos-dbg\", \"buildnumber\": 21077, \"got_angle_revision\": \"a8c01862f57fa91092304bcd02f8072783160848\", \"got_dawn_revision\": \"25eb373eede4aaa8ed069457e2c05b9c9eab9db2\", \"got_nacl_revision\": \"0fabd6dc4222dfae664e55a84326e0c904f5b62c\", \"got_revision\": \"940811014dc2880958d172cf05449c47a58cbb4e\", \"got_revision_cp\": \"refs/heads/master@{#822679}\", \"got_swarming_client_revision\": \"d46ea7635f2911208268170512cb611412488fd8\", \"got_swiftshader_revision\": \"e0de282e678b72dac25b81f8d25305231aec01f8\", \"got_v8_revision\": \"ffc771df4710e998f73be031890f60ce2f69d513\", \"got_v8_revision_cp\": \"refs/heads/8.8.211@{#1}\", \"got_webrtc_revision\": \"ee24eb66d23ffea5ef729dc340e1fc4381c72a4a\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#32507}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"940811014dc2880958d172cf05449c47a58cbb4e\", \"swarm_hashes_refs/heads/master(at){#822679}_without_patch\": {\"absl_hardening_tests\": \"91ca5cef8b70710c323220c50da3310e2822fecd\", \"accessibility_unittests\": \"d66265c136f74738ca4b2defff66b520a1614796\", \"angle_unittests\": \"2be7aa689fcbae6fadd7dadd30ec752cf0c95b24\", \"app_list_unittests\": \"22cdaf583f022c88598e3230c5602495c71eeb61\", \"app_shell_unittests\": \"dad6c611507fb8e9d8089840475728865e97772f\", \"ash_unittests\": \"9b261b40d51a81374046021af5a44259f0b0b7bc\", \"aura_unittests\": \"1fac3d24e181bc825543765b4926596f77d69c3e\", \"base_unittests\": \"9313528d5e69d11cd0f96335ded1e678f101fd6d\", \"base_util_unittests\": \"964f8d61d895ab7f53c1fd5034412586788e4a5f\", \"blink_common_unittests\": \"bad9d58c45638d3a4d470d77bfac1030dec7ec80\", \"blink_fuzzer_unittests\": \"a0e8e71a2475fd1a23f5e3d873e870df80758665\", \"blink_heap_unittests\": \"b1282aa3a62d83d37dc3e86f209b0c0c77a956b6\", \"blink_platform_unittests\": \"f5a072cb79730876cdd1bb98427ba7f625043880\", \"blink_unittests\": \"7cb0005b9cce94480edad2e808ce6f24f31bed23\", \"boringssl_crypto_tests\": \"a90c17c865e4f6b8baa94bea0f33ca11725d96ec\", \"boringssl_ssl_tests\": \"2f4647f47d17c97e144bf937c330587ac591971b\", \"browser_tests\": \"c606af8e19a2c6fe414e53d6c521f630f82aaf1b\", \"capture_unittests\": \"4e5e2d55ebf5f4fc700ad26690ba5e90ec5d6d3f\", \"cast_unittests\": \"746340fbad12f38978b79636b2aff744d2eae6b2\", \"cc_unittests\": \"5cf36ec7efc254ad4a4ca09c5d039313afbbe102\", \"chrome_app_unittests\": \"ca7e2edd1cd2cebd2eb94017d668d18e4b5e451c\", \"chromedriver_unittests\": \"40c13cb681ea3576a9afc7bb68302fc844e68c27\", \"chromeos_components_unittests\": \"effe2bac3780495db0915f2edeeaea8040e1dc6f\", \"chromeos_unittests\": \"3351c6c00798eaf71fd843f2a6ed4f18d83e2c3d\", \"components_browsertests\": \"1de73e50d6682e9aeba58985506dc7d1a844e68b\", \"components_unittests\": \"f6892d444143bbbe72dbba669458ce1c2252bbb8\", \"compositor_unittests\": \"60b54f717bfd56d3b423ed846e51af4baa556f6b\", \"content_browsertests\": \"9477d4eb2f3a88885d4f9d97f0a833a44d84a5ee\", \"content_unittests\": \"e2495688c166c0adaeb6ee5ad115eaabbaba2794\", \"crypto_unittests\": \"a7a9f41ddbe2d9dfb0c361f731af97d2b6d6a1a1\", \"dbus_unittests\": \"bdb7b6aa16ad0db479ec8d19dd92ba921371afd7\", \"device_unittests\": \"ecb4687e89e9f9735e6a042216f659a45bbafbe1\", \"display_unittests\": \"6d166ca9be2209e3a478a129086dd90bc971af1d\", \"events_unittests\": \"40f4c4600d0d16230afa61eaaca8d0a37590b275\", \"exo_unittests\": \"f62a06918f7247ec1bd09b8ec02d157590fa84af\", \"extensions_browsertests\": \"9e0f46cfd04ba4143fc632e3ce211a4745b02b01\", \"extensions_unittests\": \"7fee81146c8e3c896e890294452e20e6302e9b8d\", \"filesystem_service_unittests\": \"f5829e3207b8bdda9bd953f77ce0f4bf850e9eaa\", \"gcm_unit_tests\": \"f22f458a57118bac11ee8a2e1a026f89812f5d69\", \"gfx_unittests\": \"48858e8fb16f2c48a290d3c0669c40b08e92f1e5\", \"gin_unittests\": \"a4ad1eac847f0ec6b1bf4e0268efb9ec11eabf2d\", \"gl_unittests_ozone\": \"9df4151b7c72c4e79ac43885499d3c660092966f\", \"google_apis_unittests\": \"9c4b1f88aad94fe63f1dd2510459e7d6ff9030c8\", \"gpu_unittests\": \"8c23e70a9bea3f83e675422372629bee1350112b\", \"gwp_asan_unittests\": \"5b115f8c06a89678d20fe3dd6c2d9c7314399733\", \"interactive_ui_tests\": \"35fa26dddcab4e36d1085593c8c0d5e232d84830\", \"ipc_tests\": \"252840faa6e915435bd44fc12c569c7edba776c9\", \"jingle_unittests\": \"f1541ae5cad6d3075165e8fb59d0c275e7c1c742\", \"keyboard_unittests\": \"161b116765d0a85e570e6d10b28b19899df40ca4\", \"latency_unittests\": \"de027fb787687f59cc9d0f38aaff7756197fa2b8\", \"libjingle_xmpp_unittests\": \"b820971abda9682df5bab9488d5ed8b7e805c821\", \"liburlpattern_unittests\": \"3d15d17aabc573c514cb7fd9dc3f2e8612ca25d5\", \"media_blink_unittests\": \"7c3464c9d9686cf7702f502489a6acd7ae62161a\", \"media_unittests\": \"18671ffc8b3adec04d83d84e52a3b142d75cd584\", \"message_center_unittests\": \"6c6da9ef077b5ef22fd8c0caac89b73698d1b11f\", \"midi_unittests\": \"ee999657be34bd7d7a8452523a1902cc58f9dfd7\", \"mojo_core_unittests\": \"9088cca62d3622ee92877190cf7b3194d14e3522\", \"mojo_unittests\": \"83412166d7f49b29742cc84c4580de6eb90903fd\", \"nacl_helper_nonsfi_unittests\": \"4ad76f1a2ae48a8ef0dc4bb3c8079d84c931f3ac\", \"nacl_loader_unittests\": \"a5b06e3d3ae81e6b17b03a79830ba2dde503eb0b\", \"native_theme_unittests\": \"8b848bdcf81a7680ce546bc41377343aa41980a4\", \"net_unittests\": \"24f75c624a6ade752d759a20a91ee4642c9db532\", \"ozone_gl_unittests\": \"6e0eeaa6201d426df71dafa43596f199a762cf55\", \"ozone_unittests\": \"9724d5ef0f930ed0bb7ed316b3c6c61cce2c4dc8\", \"ozone_x11_unittests\": \"f173a8bf38ab322b0f73426662fc6b8cd1b724c8\", \"pdf_unittests\": \"31787a2be4cf8c041ccf6e7ebf2073e285857f82\", \"perfetto_unittests\": \"d65e818605fd9623a16db0a78a12cd89908f268d\", \"ppapi_unittests\": \"fe4ea9b8b088fa683debbde5e35d8cd4549a15ac\", \"printing_unittests\": \"63f7495fd13c41fd201c2ef219c910b25710f50a\", \"remoting_unittests\": \"a6f7d9193188b87ad71d303de113546ebd8cbc58\", \"sandbox_linux_unittests\": \"bec14bf6be907e74deb2ee148e2b0544d0c906a7\", \"service_manager_unittests\": \"72c30a3101f3b50e7edf2da87a05a1f2c9f108ac\", \"services_unittests\": \"96e5bda47e24bddf0c884711f41b40af3c670a2c\", \"shell_dialogs_unittests\": \"ade2ab3203d6a68c05aa4ba86f16743c8963c109\", \"skia_unittests\": \"1f915fce9582dadf416c5e65cd4b44e60aa88e73\", \"snapshot_unittests\": \"c7742228aa1071774490844604ec4a929e34624b\", \"sql_unittests\": \"f969a5e8dd41ed6fa97ed220eb8e2737b11de565\", \"storage_unittests\": \"ae8154d17fc3cb34c5d16b5e4431702262878197\", \"sync_integration_tests\": \"e1fef2f9f615044d50f92a0a31f53a72a66f2457\", \"traffic_annotation_auditor_unittests\": \"6fdce94bb360936cfa38554bdb7dd351e95dada2\", \"ui_base_unittests\": \"70d5d97796da1df95af6097ddd9e00251db6d8ea\", \"ui_chromeos_unittests\": \"21be03cc6bafab43f941e09260ed410a2a6b7294\", \"ui_touch_selection_unittests\": \"08eafa989d1747e218e304b3918cc041a04023b0\", \"unit_tests\": \"a516422c1967cbb6aaccaafa545b8ae452b1b4d2\", \"url_unittests\": \"1ea09cccd77a100ee37fab6548d9cb8c068aaa4c\", \"usage_time_limit_unittests\": \"f9246edfc3a2789de8ae0cadf06a358fb9b13e61\", \"views_unittests\": \"4673f7c5a3d73ee33f369086e611f6aeb87f55a8\", \"viz_unittests\": \"a91c09c9dd1973b35a441d16378b83165c7d6d1d\", \"wm_unittests\": \"aa09700edd392b7693119b02a18d9422cd653119\", \"wtf_unittests\": \"f98c816170d65050995dc1a6f083247954d11d22\", \"zlib_unittests\": \"2b2f04703bac3d9a5c17c790948a445bc678e713\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_06bf165a3bf7a25e93955b74ebaf013d13a4a87ad7bcb716437f8a47afa74d09_v2\", \"builder_6e17dc7623fba43c9632527d18d71e4843b504e37694b559b7b91daecd01d18c_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"8\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Haswell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"luci-chromium-ci-xenial-us-east1-d-8-8-gwu0\"], \"image\": [\"chrome-xenial-20102500-5da31bca5f9\"], \"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\": [\"5614-d862eaa\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-east\", \"us-east1\", \"us-east1-d\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1604077386257144",
"status": "COMPLETED",
"status_changed_ts": "1604084032550979",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-dbg/21077",
"builder:linux-chromeos-dbg",
"buildset:commit/git/940811014dc2880958d172cf05449c47a58cbb4e",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/940811014dc2880958d172cf05449c47a58cbb4e",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9030427020052725712",
"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/8864996958031787776/+/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:4f9343d2445f8e10",
"user_agent:luci-scheduler"
],
"updated_ts": "1604084032566167",
"url": "https://ci.chromium.org/b/8864996958031787776",
"utcnow_ts": "1604084033728782"
}
}
[18:53:53.787] Invocation finished in 1h55m26.784417749s with status SUCCEEDED