[02:21:13.710] New invocation is queued and will start shortly
[02:21:14.905] Starting the invocation (attempt 1)
[02:21:14.965] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[02:21:14.965] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[02:21:14.965] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9023959228494921760",
"parameters_json": "{\"builder_name\":\"linux-chromeos-dbg\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"487ebc5018e36bf394c86085c058620a0f71c86b\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:linux-chromeos-dbg",
"scheduler_invocation_id:9023959228494921760",
"scheduler_job_id:chromium/linux-chromeos-dbg",
"user_agent:luci-scheduler",
"buildset:commit/git/487ebc5018e36bf394c86085c058620a0f71c86b",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/487ebc5018e36bf394c86085c058620a0f71c86b",
"gitiles_ref:refs/heads/master"
]
}
[02:21:15.701] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1610245275067980",
"id": "8858529166410106528",
"parameters_json": "{\"builder_name\": \"linux-chromeos-dbg\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"487ebc5018e36bf394c86085c058620a0f71c86b\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1610245275461902",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-dbg/22134",
"builder:linux-chromeos-dbg",
"buildset:commit/git/487ebc5018e36bf394c86085c058620a0f71c86b",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/487ebc5018e36bf394c86085c058620a0f71c86b",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9023959228494921760",
"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/8858529166410106528/+/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": "1610245275462011",
"url": "https://ci.chromium.org/b/8858529166410106528",
"utcnow_ts": "1610245275694154"
}
}
[02:21:15.701] Task URL: https://ci.chromium.org/b/8858529166410106528
[02:21:15.701] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:2:0) after 1m0s
[02:22:15.818] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:2:0)
[02:22:15.818] Timer tick, asking Buildbucket for the build status
[02:22:16.029] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:22:16.029] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:3:0) after 1m0s
[02:23:16.063] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:3:0)
[02:23:16.063] Timer tick, asking Buildbucket for the build status
[02:23:16.224] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:23:16.224] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:4:0) after 1m0s
[02:24:16.283] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:4:0)
[02:24:16.284] Timer tick, asking Buildbucket for the build status
[02:24:16.388] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:24:16.388] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:5:0) after 1m0s
[02:25:16.463] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:5:0)
[02:25:16.463] Timer tick, asking Buildbucket for the build status
[02:25:16.562] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:25:16.562] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:6:0) after 1m0s
[02:26:16.763] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:6:0)
[02:26:16.763] Timer tick, asking Buildbucket for the build status
[02:26:16.824] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:26:16.824] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:7:0) after 1m0s
[02:27:16.876] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:7:0)
[02:27:16.876] Timer tick, asking Buildbucket for the build status
[02:27:16.951] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:27:16.951] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:8:0) after 1m0s
[02:28:17.004] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:8:0)
[02:28:17.004] Timer tick, asking Buildbucket for the build status
[02:28:17.098] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:28:17.098] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:9:0) after 1m0s
[02:29:17.156] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:9:0)
[02:29:17.156] Timer tick, asking Buildbucket for the build status
[02:29:17.315] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:29:17.315] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:10:0) after 1m0s
[02:30:17.409] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:10:0)
[02:30:17.409] Timer tick, asking Buildbucket for the build status
[02:30:17.478] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:30:17.478] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:11:0) after 1m0s
[02:31:17.503] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:11:0)
[02:31:17.503] Timer tick, asking Buildbucket for the build status
[02:31:17.714] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:31:17.714] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:12:0) after 1m0s
[02:32:17.741] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:12:0)
[02:32:17.742] Timer tick, asking Buildbucket for the build status
[02:32:17.818] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:32:17.818] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:13:0) after 1m0s
[02:33:18.022] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:13:0)
[02:33:18.022] Timer tick, asking Buildbucket for the build status
[02:33:18.084] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:33:18.084] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:14:0) after 1m0s
[02:34:18.150] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:14:0)
[02:34:18.150] Timer tick, asking Buildbucket for the build status
[02:34:18.231] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:34:18.231] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:15:0) after 1m0s
[02:35:18.399] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:15:0)
[02:35:18.399] Timer tick, asking Buildbucket for the build status
[02:35:18.538] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:35:18.538] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:16:0) after 1m0s
[02:36:18.755] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:16:0)
[02:36:18.755] Timer tick, asking Buildbucket for the build status
[02:36:18.842] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:36:18.842] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:17:0) after 1m0s
[02:37:18.955] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:17:0)
[02:37:18.955] Timer tick, asking Buildbucket for the build status
[02:37:19.052] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:37:19.052] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:18:0) after 1m0s
[02:38:19.217] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:18:0)
[02:38:19.217] Timer tick, asking Buildbucket for the build status
[02:38:19.293] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:38:19.293] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:19:0) after 1m0s
[02:39:19.360] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:19:0)
[02:39:19.360] Timer tick, asking Buildbucket for the build status
[02:39:19.431] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:39:19.431] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:20:0) after 1m0s
[02:40:19.550] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:20:0)
[02:40:19.550] Timer tick, asking Buildbucket for the build status
[02:40:19.620] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:40:19.620] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:21:0) after 1m0s
[02:41:19.663] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:21:0)
[02:41:19.663] Timer tick, asking Buildbucket for the build status
[02:41:19.749] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:41:19.749] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:22:0) after 1m0s
[02:42:19.887] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:22:0)
[02:42:19.887] Timer tick, asking Buildbucket for the build status
[02:42:20.111] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:42:20.111] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:23:0) after 1m0s
[02:43:20.212] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:23:0)
[02:43:20.212] Timer tick, asking Buildbucket for the build status
[02:43:20.279] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:43:20.279] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:24:0) after 1m0s
[02:44:20.544] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:24:0)
[02:44:20.544] Timer tick, asking Buildbucket for the build status
[02:44:20.627] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:44:20.627] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:25:0) after 1m0s
[02:45:20.699] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:25:0)
[02:45:20.699] Timer tick, asking Buildbucket for the build status
[02:45:20.766] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:45:20.766] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:26:0) after 1m0s
[02:46:20.835] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:26:0)
[02:46:20.835] Timer tick, asking Buildbucket for the build status
[02:46:20.924] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:46:20.924] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:27:0) after 1m0s
[02:47:20.963] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:27:0)
[02:47:20.963] Timer tick, asking Buildbucket for the build status
[02:47:21.105] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:47:21.105] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:28:0) after 1m0s
[02:48:21.125] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:28:0)
[02:48:21.125] Timer tick, asking Buildbucket for the build status
[02:48:21.210] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:48:21.210] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:29:0) after 1m0s
[02:49:21.241] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:29:0)
[02:49:21.241] Timer tick, asking Buildbucket for the build status
[02:49:21.312] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:49:21.312] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:30:0) after 1m0s
[02:50:21.419] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:30:0)
[02:50:21.419] Timer tick, asking Buildbucket for the build status
[02:50:21.482] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:50:21.482] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:31:0) after 1m0s
[02:51:21.544] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:31:0)
[02:51:21.544] Timer tick, asking Buildbucket for the build status
[02:51:21.807] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:51:21.807] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:32:0) after 1m0s
[02:52:21.904] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:32:0)
[02:52:21.904] Timer tick, asking Buildbucket for the build status
[02:52:21.967] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:52:21.967] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:33:0) after 1m0s
[02:53:21.952] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:33:0)
[02:53:21.952] Timer tick, asking Buildbucket for the build status
[02:53:22.011] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:53:22.011] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:34:0) after 1m0s
[02:54:22.051] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:34:0)
[02:54:22.051] Timer tick, asking Buildbucket for the build status
[02:54:22.122] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:54:22.123] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:35:0) after 1m0s
[02:55:22.255] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:35:0)
[02:55:22.255] Timer tick, asking Buildbucket for the build status
[02:55:22.364] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:55:22.364] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:36:0) after 1m0s
[02:56:22.391] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:36:0)
[02:56:22.391] Timer tick, asking Buildbucket for the build status
[02:56:22.494] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:56:22.494] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:37:0) after 1m0s
[02:57:22.521] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:37:0)
[02:57:22.521] Timer tick, asking Buildbucket for the build status
[02:57:22.643] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:57:22.643] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:38:0) after 1m0s
[02:58:22.646] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:38:0)
[02:58:22.646] Timer tick, asking Buildbucket for the build status
[02:58:22.835] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:58:22.835] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:39:0) after 1m0s
[02:59:22.891] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:39:0)
[02:59:22.891] Timer tick, asking Buildbucket for the build status
[02:59:22.999] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[02:59:22.999] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:40:0) after 1m0s
[03:00:23.049] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:40:0)
[03:00:23.049] Timer tick, asking Buildbucket for the build status
[03:00:23.409] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[03:00:23.409] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:41:0) after 1m0s
[03:01:23.438] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:41:0)
[03:01:23.438] Timer tick, asking Buildbucket for the build status
[03:01:23.544] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[03:01:23.544] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:42:0) after 1m0s
[03:02:23.578] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:42:0)
[03:02:23.578] Timer tick, asking Buildbucket for the build status
[03:02:23.666] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[03:02:23.666] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:43:0) after 1m0s
[03:03:23.769] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:43:0)
[03:03:23.770] Timer tick, asking Buildbucket for the build status
[03:03:23.958] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[03:03:23.958] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:44:0) after 1m0s
[03:04:23.968] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:44:0)
[03:04:23.968] Timer tick, asking Buildbucket for the build status
[03:04:24.230] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[03:04:24.230] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:45:0) after 1m0s
[03:05:24.252] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:45:0)
[03:05:24.252] Timer tick, asking Buildbucket for the build status
[03:05:24.350] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[03:05:24.350] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:46:0) after 1m0s
[03:06:24.417] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:46:0)
[03:06:24.417] Timer tick, asking Buildbucket for the build status
[03:06:24.553] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[03:06:24.553] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:47:0) after 1m0s
[03:07:24.620] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:47:0)
[03:07:24.620] Timer tick, asking Buildbucket for the build status
[03:07:24.677] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[03:07:24.677] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:48:0) after 1m0s
[03:08:24.680] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:48:0)
[03:08:24.680] Timer tick, asking Buildbucket for the build status
[03:08:24.740] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[03:08:24.740] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:49:0) after 1m0s
[03:09:24.806] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:49:0)
[03:09:24.806] Timer tick, asking Buildbucket for the build status
[03:09:24.892] Build 8858529166410106528: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[03:09:24.892] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:50:0) after 1m0s
[03:09:54.069] Received PubSub notification, asking Buildbucket for the build status
[03:09:54.263] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:10:24.926] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:50:0)
[03:10:24.926] Timer tick, asking Buildbucket for the build status
[03:10:24.995] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:10:24.995] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:52:0) after 1m0s
[03:11:25.070] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:52:0)
[03:11:25.070] Timer tick, asking Buildbucket for the build status
[03:11:25.178] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:11:25.178] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:53:0) after 1m0s
[03:12:25.158] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:53:0)
[03:12:25.158] Timer tick, asking Buildbucket for the build status
[03:12:25.285] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:12:25.285] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:54:0) after 1m0s
[03:13:25.376] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:54:0)
[03:13:25.376] Timer tick, asking Buildbucket for the build status
[03:13:25.476] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:13:25.476] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:55:0) after 1m0s
[03:14:25.520] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:55:0)
[03:14:25.520] Timer tick, asking Buildbucket for the build status
[03:14:25.575] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:14:25.575] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:56:0) after 1m0s
[03:15:25.594] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:56:0)
[03:15:25.594] Timer tick, asking Buildbucket for the build status
[03:15:25.655] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:15:25.655] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:57:0) after 1m0s
[03:16:25.656] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:57:0)
[03:16:25.656] Timer tick, asking Buildbucket for the build status
[03:16:25.747] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:16:25.747] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:58:0) after 1m0s
[03:17:25.768] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:58:0)
[03:17:25.768] Timer tick, asking Buildbucket for the build status
[03:17:25.926] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:17:25.926] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:59:0) after 1m0s
[03:18:25.953] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:59:0)
[03:18:25.953] Timer tick, asking Buildbucket for the build status
[03:18:26.036] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:18:26.036] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:60:0) after 1m0s
[03:19:26.139] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:60:0)
[03:19:26.139] Timer tick, asking Buildbucket for the build status
[03:19:26.203] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:19:26.203] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:61:0) after 1m0s
[03:20:26.479] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:61:0)
[03:20:26.479] Timer tick, asking Buildbucket for the build status
[03:20:26.612] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:20:26.612] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:62:0) after 1m0s
[03:21:26.793] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:62:0)
[03:21:26.793] Timer tick, asking Buildbucket for the build status
[03:21:26.932] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:21:26.932] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:63:0) after 1m0s
[03:22:27.038] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:63:0)
[03:22:27.038] Timer tick, asking Buildbucket for the build status
[03:22:27.211] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:22:27.211] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:64:0) after 1m0s
[03:23:27.433] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:64:0)
[03:23:27.433] Timer tick, asking Buildbucket for the build status
[03:23:27.489] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:23:27.489] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:65:0) after 1m0s
[03:24:27.562] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:65:0)
[03:24:27.562] Timer tick, asking Buildbucket for the build status
[03:24:27.860] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:24:27.860] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:66:0) after 1m0s
[03:25:27.936] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:66:0)
[03:25:27.936] Timer tick, asking Buildbucket for the build status
[03:25:28.018] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:25:28.018] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:67:0) after 1m0s
[03:26:28.137] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:67:0)
[03:26:28.137] Timer tick, asking Buildbucket for the build status
[03:26:28.247] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:26:28.247] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:68:0) after 1m0s
[03:27:28.316] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:68:0)
[03:27:28.316] Timer tick, asking Buildbucket for the build status
[03:27:28.364] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:27:28.364] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:69:0) after 1m0s
[03:28:28.467] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:69:0)
[03:28:28.467] Timer tick, asking Buildbucket for the build status
[03:28:28.901] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:28:28.901] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:70:0) after 1m0s
[03:29:30.682] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:70:0)
[03:29:30.682] Timer tick, asking Buildbucket for the build status
[03:29:30.735] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:29:30.735] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:71:0) after 1m0s
[03:30:30.887] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:71:0)
[03:30:30.887] Timer tick, asking Buildbucket for the build status
[03:30:30.954] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:30:30.954] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:72:0) after 1m0s
[03:31:31.158] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:72:0)
[03:31:31.158] Timer tick, asking Buildbucket for the build status
[03:31:31.257] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:31:31.257] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:73:0) after 1m0s
[03:32:31.581] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:73:0)
[03:32:31.581] Timer tick, asking Buildbucket for the build status
[03:32:31.764] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:32:31.764] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:74:0) after 1m0s
[03:33:31.786] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:74:0)
[03:33:31.787] Timer tick, asking Buildbucket for the build status
[03:33:32.146] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:33:32.146] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:75:0) after 1m0s
[03:34:32.126] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:75:0)
[03:34:32.126] Timer tick, asking Buildbucket for the build status
[03:34:32.183] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:34:32.183] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:76:0) after 1m0s
[03:35:32.240] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:76:0)
[03:35:32.240] Timer tick, asking Buildbucket for the build status
[03:35:32.291] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:35:32.291] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:77:0) after 1m0s
[03:36:32.341] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:77:0)
[03:36:32.341] Timer tick, asking Buildbucket for the build status
[03:36:32.492] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:36:32.492] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:78:0) after 1m0s
[03:37:32.511] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:78:0)
[03:37:32.511] Timer tick, asking Buildbucket for the build status
[03:37:32.561] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:37:32.561] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:79:0) after 1m0s
[03:38:32.587] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:79:0)
[03:38:32.587] Timer tick, asking Buildbucket for the build status
[03:38:32.640] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:38:32.640] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:80:0) after 1m0s
[03:39:32.704] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:80:0)
[03:39:32.704] Timer tick, asking Buildbucket for the build status
[03:39:32.852] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:39:32.852] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:81:0) after 1m0s
[03:40:32.909] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:81:0)
[03:40:32.909] Timer tick, asking Buildbucket for the build status
[03:40:33.117] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:40:33.117] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:82:0) after 1m0s
[03:41:33.168] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:82:0)
[03:41:33.169] Timer tick, asking Buildbucket for the build status
[03:41:33.328] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:41:33.328] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:83:0) after 1m0s
[03:42:33.392] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:83:0)
[03:42:33.392] Timer tick, asking Buildbucket for the build status
[03:42:33.516] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:42:33.516] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:84:0) after 1m0s
[03:43:33.537] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:84:0)
[03:43:33.537] Timer tick, asking Buildbucket for the build status
[03:43:33.605] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:43:33.605] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:85:0) after 1m0s
[03:44:33.625] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:85:0)
[03:44:33.625] Timer tick, asking Buildbucket for the build status
[03:44:33.903] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:44:33.903] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:86:0) after 1m0s
[03:45:33.991] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:86:0)
[03:45:33.991] Timer tick, asking Buildbucket for the build status
[03:45:34.049] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:45:34.049] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:87:0) after 1m0s
[03:46:34.078] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:87:0)
[03:46:34.078] Timer tick, asking Buildbucket for the build status
[03:46:34.248] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:46:34.248] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:88:0) after 1m0s
[03:47:34.268] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:88:0)
[03:47:34.268] Timer tick, asking Buildbucket for the build status
[03:47:34.446] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:47:34.446] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:89:0) after 1m0s
[03:48:34.469] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:89:0)
[03:48:34.469] Timer tick, asking Buildbucket for the build status
[03:48:34.528] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:48:34.528] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:90:0) after 1m0s
[03:49:34.570] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:90:0)
[03:49:34.570] Timer tick, asking Buildbucket for the build status
[03:49:34.627] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:49:34.627] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:91:0) after 1m0s
[03:50:34.672] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:91:0)
[03:50:34.672] Timer tick, asking Buildbucket for the build status
[03:50:34.825] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:50:34.825] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:92:0) after 1m0s
[03:51:34.889] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:92:0)
[03:51:34.889] Timer tick, asking Buildbucket for the build status
[03:51:34.980] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:51:34.980] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:93:0) after 1m0s
[03:52:35.038] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:93:0)
[03:52:35.038] Timer tick, asking Buildbucket for the build status
[03:52:35.199] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:52:35.199] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:94:0) after 1m0s
[03:53:35.273] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:94:0)
[03:53:35.273] Timer tick, asking Buildbucket for the build status
[03:53:35.327] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:53:35.327] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:95:0) after 1m0s
[03:54:35.518] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:95:0)
[03:54:35.518] Timer tick, asking Buildbucket for the build status
[03:54:35.598] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:54:35.598] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:96:0) after 1m0s
[03:55:35.624] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:96:0)
[03:55:35.624] Timer tick, asking Buildbucket for the build status
[03:55:35.734] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:55:35.734] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:97:0) after 1m0s
[03:56:35.778] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:97:0)
[03:56:35.778] Timer tick, asking Buildbucket for the build status
[03:56:35.996] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:56:35.996] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:98:0) after 1m0s
[03:57:36.018] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:98:0)
[03:57:36.018] Timer tick, asking Buildbucket for the build status
[03:57:36.395] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:57:36.395] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:99:0) after 1m0s
[03:58:36.419] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:99:0)
[03:58:36.419] Timer tick, asking Buildbucket for the build status
[03:58:36.472] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:58:36.473] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:100:0) after 1m0s
[03:59:36.514] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:100:0)
[03:59:36.514] Timer tick, asking Buildbucket for the build status
[03:59:36.583] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:59:36.583] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:101:0) after 1m0s
[04:00:36.694] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:101:0)
[04:00:36.694] Timer tick, asking Buildbucket for the build status
[04:00:36.799] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:00:36.799] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:102:0) after 1m0s
[04:01:36.821] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:102:0)
[04:01:36.821] Timer tick, asking Buildbucket for the build status
[04:01:36.928] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:01:36.928] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:103:0) after 1m0s
[04:02:37.000] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:103:0)
[04:02:37.000] Timer tick, asking Buildbucket for the build status
[04:02:37.156] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:02:37.156] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:104:0) after 1m0s
[04:03:37.189] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:104:0)
[04:03:37.189] Timer tick, asking Buildbucket for the build status
[04:03:37.307] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:03:37.307] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:105:0) after 1m0s
[04:04:37.424] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:105:0)
[04:04:37.424] Timer tick, asking Buildbucket for the build status
[04:04:37.605] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:04:37.605] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:106:0) after 1m0s
[04:05:37.706] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:106:0)
[04:05:37.706] Timer tick, asking Buildbucket for the build status
[04:05:37.829] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:05:37.829] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:107:0) after 1m0s
[04:06:37.898] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:107:0)
[04:06:37.898] Timer tick, asking Buildbucket for the build status
[04:06:38.004] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:06:38.004] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:108:0) after 1m0s
[04:07:38.156] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:108:0)
[04:07:38.156] Timer tick, asking Buildbucket for the build status
[04:07:38.256] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:07:38.256] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:109:0) after 1m0s
[04:08:38.376] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:109:0)
[04:08:38.376] Timer tick, asking Buildbucket for the build status
[04:08:38.576] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:08:38.576] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:110:0) after 1m0s
[04:09:38.635] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:110:0)
[04:09:38.636] Timer tick, asking Buildbucket for the build status
[04:09:38.706] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:09:38.706] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:111:0) after 1m0s
[04:10:38.754] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:111:0)
[04:10:38.754] Timer tick, asking Buildbucket for the build status
[04:10:38.815] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:10:38.815] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:112:0) after 1m0s
[04:11:38.810] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:112:0)
[04:11:38.810] Timer tick, asking Buildbucket for the build status
[04:11:38.912] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:11:38.912] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:113:0) after 1m0s
[04:12:39.027] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:113:0)
[04:12:39.027] Timer tick, asking Buildbucket for the build status
[04:12:39.136] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:12:39.136] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:114:0) after 1m0s
[04:13:39.221] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:114:0)
[04:13:39.221] Timer tick, asking Buildbucket for the build status
[04:13:39.449] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:13:39.449] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:115:0) after 1m0s
[04:14:43.991] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:115:0)
[04:14:43.991] Timer tick, asking Buildbucket for the build status
[04:14:44.053] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:14:44.054] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:116:0) after 1m0s
[04:15:44.150] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:116:0)
[04:15:44.150] Timer tick, asking Buildbucket for the build status
[04:15:44.205] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:15:44.205] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:117:0) after 1m0s
[04:16:44.277] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:117:0)
[04:16:44.277] Timer tick, asking Buildbucket for the build status
[04:16:44.387] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:16:44.387] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:118:0) after 1m0s
[04:17:44.458] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:118:0)
[04:17:44.458] Timer tick, asking Buildbucket for the build status
[04:17:44.654] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:17:44.654] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:119:0) after 1m0s
[04:18:44.770] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:119:0)
[04:18:44.770] Timer tick, asking Buildbucket for the build status
[04:18:44.839] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:18:44.839] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:120:0) after 1m0s
[04:19:44.875] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:120:0)
[04:19:44.875] Timer tick, asking Buildbucket for the build status
[04:19:44.948] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:19:44.948] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:121:0) after 1m0s
[04:20:45.084] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:121:0)
[04:20:45.084] Timer tick, asking Buildbucket for the build status
[04:20:45.177] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:20:45.177] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:122:0) after 1m0s
[04:21:45.253] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:122:0)
[04:21:45.253] Timer tick, asking Buildbucket for the build status
[04:21:45.361] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:21:45.361] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:123:0) after 1m0s
[04:22:45.512] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:123:0)
[04:22:45.512] Timer tick, asking Buildbucket for the build status
[04:22:45.656] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:22:45.656] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:124:0) after 1m0s
[04:23:45.905] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:124:0)
[04:23:45.905] Timer tick, asking Buildbucket for the build status
[04:23:46.013] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:23:46.013] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:125:0) after 1m0s
[04:24:46.211] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:125:0)
[04:24:46.211] Timer tick, asking Buildbucket for the build status
[04:24:46.306] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:24:46.306] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:126:0) after 1m0s
[04:25:46.396] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:126:0)
[04:25:46.396] Timer tick, asking Buildbucket for the build status
[04:25:46.612] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:25:46.612] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:127:0) after 1m0s
[04:26:46.720] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:127:0)
[04:26:46.720] Timer tick, asking Buildbucket for the build status
[04:26:46.829] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:26:46.829] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:128:0) after 1m0s
[04:27:46.911] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:128:0)
[04:27:46.911] Timer tick, asking Buildbucket for the build status
[04:27:46.978] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:27:46.978] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:129:0) after 1m0s
[04:28:47.000] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:129:0)
[04:28:47.000] Timer tick, asking Buildbucket for the build status
[04:28:47.086] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:28:47.086] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:130:0) after 1m0s
[04:29:47.197] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:130:0)
[04:29:47.197] Timer tick, asking Buildbucket for the build status
[04:29:47.260] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:29:47.261] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:131:0) after 1m0s
[04:30:47.415] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:131:0)
[04:30:47.415] Timer tick, asking Buildbucket for the build status
[04:30:47.800] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:30:47.800] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:132:0) after 1m0s
[04:31:47.857] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:132:0)
[04:31:47.857] Timer tick, asking Buildbucket for the build status
[04:31:48.001] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:31:48.001] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:133:0) after 1m0s
[04:32:48.045] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:133:0)
[04:32:48.045] Timer tick, asking Buildbucket for the build status
[04:32:48.142] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:32:48.142] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:134:0) after 1m0s
[04:33:48.182] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:134:0)
[04:33:48.182] Timer tick, asking Buildbucket for the build status
[04:33:48.294] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:33:48.294] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:135:0) after 1m0s
[04:34:48.345] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:135:0)
[04:34:48.345] Timer tick, asking Buildbucket for the build status
[04:34:48.473] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:34:48.473] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:136:0) after 1m0s
[04:35:48.512] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:136:0)
[04:35:48.512] Timer tick, asking Buildbucket for the build status
[04:35:48.566] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:35:48.566] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:137:0) after 1m0s
[04:36:48.656] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:137:0)
[04:36:48.656] Timer tick, asking Buildbucket for the build status
[04:36:48.781] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:36:48.781] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:138:0) after 1m0s
[04:37:48.822] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:138:0)
[04:37:48.822] Timer tick, asking Buildbucket for the build status
[04:37:48.940] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:37:48.940] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:139:0) after 1m0s
[04:38:49.002] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:139:0)
[04:38:49.002] Timer tick, asking Buildbucket for the build status
[04:38:49.185] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:38:49.186] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:140:0) after 1m0s
[04:39:49.242] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:140:0)
[04:39:49.242] Timer tick, asking Buildbucket for the build status
[04:39:49.592] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:39:49.592] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:141:0) after 1m0s
[04:40:49.648] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:141:0)
[04:40:49.648] Timer tick, asking Buildbucket for the build status
[04:40:49.723] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:40:49.723] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:142:0) after 1m0s
[04:41:49.826] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:142:0)
[04:41:49.826] Timer tick, asking Buildbucket for the build status
[04:41:50.494] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:41:50.494] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:143:0) after 1m0s
[04:42:50.682] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:143:0)
[04:42:50.682] Timer tick, asking Buildbucket for the build status
[04:42:50.746] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:42:50.746] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:144:0) after 1m0s
[04:43:50.799] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:144:0)
[04:43:50.799] Timer tick, asking Buildbucket for the build status
[04:43:50.865] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:43:50.865] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:145:0) after 1m0s
[04:44:50.920] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:145:0)
[04:44:50.920] Timer tick, asking Buildbucket for the build status
[04:44:50.977] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:44:50.977] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:146:0) after 1m0s
[04:45:51.063] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:146:0)
[04:45:51.063] Timer tick, asking Buildbucket for the build status
[04:45:51.150] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:45:51.150] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:147:0) after 1m0s
[04:46:51.183] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:147:0)
[04:46:51.183] Timer tick, asking Buildbucket for the build status
[04:46:51.427] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:46:51.427] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:148:0) after 1m0s
[04:47:51.564] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:148:0)
[04:47:51.564] Timer tick, asking Buildbucket for the build status
[04:47:51.624] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:47:51.624] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:149:0) after 1m0s
[04:48:51.715] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:149:0)
[04:48:51.715] Timer tick, asking Buildbucket for the build status
[04:48:51.776] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:48:51.776] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:150:0) after 1m0s
[04:49:51.886] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:150:0)
[04:49:51.886] Timer tick, asking Buildbucket for the build status
[04:49:52.239] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:49:52.239] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:151:0) after 1m0s
[04:50:52.302] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:151:0)
[04:50:52.302] Timer tick, asking Buildbucket for the build status
[04:50:52.642] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:50:52.642] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:152:0) after 1m0s
[04:51:52.667] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:152:0)
[04:51:52.667] Timer tick, asking Buildbucket for the build status
[04:51:53.376] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:51:53.376] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:153:0) after 1m0s
[04:52:53.387] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:153:0)
[04:52:53.387] Timer tick, asking Buildbucket for the build status
[04:52:53.824] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:52:53.824] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:154:0) after 1m0s
[04:53:53.971] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:154:0)
[04:53:53.971] Timer tick, asking Buildbucket for the build status
[04:53:54.838] Build 8858529166410106528: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:53:54.838] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9023959228494921760:155:0) after 1m0s
[04:54:47.294] Received PubSub notification, asking Buildbucket for the build status
[04:54:47.691] Build 8858529166410106528: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[04:54:47.691] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1610254485855685",
"created_by": "project:chromium",
"created_ts": "1610245275067980",
"id": "8858529166410106528",
"parameters_json": "{\"builder_name\": \"linux-chromeos-dbg\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"487ebc5018e36bf394c86085c058620a0f71c86b\"}}",
"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\": \"487ebc5018e36bf394c86085c058620a0f71c86b\", \"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-62-043q\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.chromiumos\", \"buildername\": \"linux-chromeos-dbg\", \"buildnumber\": 22134, \"got_angle_revision\": \"0b90eef09f607336330f318bc8e65fa981634160\", \"got_dawn_revision\": \"3a0405597374c9ae12fb93e33aac35826455a958\", \"got_nacl_revision\": \"d28e6c52e05ea2f1b3231de473b6dbfce59bce40\", \"got_revision\": \"487ebc5018e36bf394c86085c058620a0f71c86b\", \"got_revision_cp\": \"refs/heads/master@{#841855}\", \"got_swarming_client_revision\": \"1a072711d4388c62e02480fabc26c68c24494be9\", \"got_swiftshader_revision\": \"588d32cb3f172d1a6092c2b3c7e5a5c5d8b3b06e\", \"got_v8_revision\": \"5d60a181de0863d8d00ae42ec0ee3521f51b501a\", \"got_v8_revision_cp\": \"refs/heads/8.9.229@{#1}\", \"got_webrtc_revision\": \"42082f9045e74e65b9e3a66b51093e0dc2f9375a\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#32929}\", \"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\": \"487ebc5018e36bf394c86085c058620a0f71c86b\", \"swarm_hashes_refs/heads/master(at){#841855}_without_patch\": {\"absl_hardening_tests\": \"c6411cc03afe462cf9803ed5b6d708383a3d7fc9\", \"accessibility_unittests\": \"007d2aadce8c03e1d158242831e55789d408249d\", \"angle_unittests\": \"246b3b66cfc793f4b98eae20b6e47946d4ac08e8\", \"app_list_unittests\": \"4ca220a57cbf8c197d82ed0f008c0cbae1e002dd\", \"app_shell_unittests\": \"4100067109f9e420f5690fd64e6c9fe9a165c600\", \"ash_unittests\": \"96ef8f2a9f36903a9897d85c27a697c9c11dab62\", \"aura_unittests\": \"3ad346120e2a550941ffc23edf9163c730c80245\", \"base_unittests\": \"775e0005edd796ebe8e35ae7da43766a1cee45e7\", \"base_util_unittests\": \"2a1a389aec708f3db20380d541bee09456bae1c7\", \"blink_common_unittests\": \"c0a6b5647c83cdaf80d5c79f86a9ccf10a230f0a\", \"blink_fuzzer_unittests\": \"7e23b95306e0311d57a8c5a8c7b81178b1ab8747\", \"blink_heap_unittests\": \"f7d09b097dd740ab4a6460c21991b0237ae94190\", \"blink_platform_unittests\": \"8e75a2f4f8e874a5f56b43dbb0b2757cf14d2a8f\", \"blink_unittests\": \"7d3fb7590cc6152f45ddc552ed26e8048028a8c6\", \"boringssl_crypto_tests\": \"ec0964ee01061653efcfb32a145e4af460add661\", \"boringssl_ssl_tests\": \"e1cd0db01939a71f09bc99c64d2baba84007b0ce\", \"browser_tests\": \"4dcfe38d997380de995e492d1e40cd30005e7ea9\", \"capture_unittests\": \"02f7ea30af6226064a8ffaf458afb6a5d746a436\", \"cast_unittests\": \"f89838465b5a3adcdde21a0355fe9e3f5568165b\", \"cc_unittests\": \"a749e796523ed87abf714fa4e87ae3f674bd4164\", \"chrome_app_unittests\": \"b3b7a084ee13e780c5b9a0c06792b2ee5650d7af\", \"chromedriver_unittests\": \"f4f8c76b1471b97f2234065e5224d2d37724609f\", \"chromeos_components_unittests\": \"9d03c22d100544f2cdd3bd2031fdcf3a002ddd54\", \"chromeos_unittests\": \"e669b3c66b8020633919bc2cd8d8d986d01081ea\", \"components_browsertests\": \"5acb1d1cd1e259060647ebd95d0836ef82789a54\", \"components_unittests\": \"f30cacb64c288f0d4d1575b1631373b3970ff341\", \"compositor_unittests\": \"913264548f18004f7563dd4cce04a02d78b59a3a\", \"content_browsertests\": \"f3bf93aed6aedb07faa7f6beea79136b0f418984\", \"content_unittests\": \"42e79838e9330eaf8526ed76c88918cf2bfcfec5\", \"crashpad_tests\": \"eb9f3cc3d640807714ccb1c0e139e99fc26c5670\", \"crypto_unittests\": \"a7bfb1c5daf5f46174049690ce71a248216eb03a\", \"dbus_unittests\": \"95fa8e4643078d789f2163a1fa0ca4d1e18d0985\", \"device_unittests\": \"fb0527df2edc37c95362ccb73d70467e2830cdc2\", \"display_unittests\": \"ed49eaff60caac44418d41b7b590107a4ad2c27b\", \"events_unittests\": \"b2accfdb426e9c94de624b9abbb3673b94cec522\", \"exo_unittests\": \"24cecc67d7c2ebd9d52286201ad04082b5fac0ba\", \"extensions_browsertests\": \"69eda0ed621b0f586b4e35964d039aa27db53dba\", \"extensions_unittests\": \"b1609862b7edd5d9e1e95062191a226291f294bc\", \"filesystem_service_unittests\": \"4115332df04667427a6323ab629e279bbfa092ae\", \"gcm_unit_tests\": \"9e6d020693ef4284911c11b6a9e1240c3c10e836\", \"gfx_unittests\": \"7e0dc93c6e184206df51aaefe8603811348074ee\", \"gin_unittests\": \"84d6ba3a2761760c197298ecc59f6114a90de229\", \"gl_unittests_ozone\": \"b671378f7a92dfca446117f9548881365a732ce9\", \"google_apis_unittests\": \"2a35422f66fbc7372c14091ab64dfee2dca1eaca\", \"gpu_unittests\": \"3cab0aa72201ce047b2dcfa7b866dcbd689b4bed\", \"gwp_asan_unittests\": \"b08b594580bd17aee44a54328faecbde87d24ac8\", \"interactive_ui_tests\": \"0bb7493cf4e7921ad4ba239d3330bf7f77fdb25c\", \"ipc_tests\": \"b71ea8c2cf8c4d05ac13c226f2e6a4207acc4d4c\", \"jingle_unittests\": \"7706e031667e8829640a73a4e87e2d2f81c2cb65\", \"keyboard_unittests\": \"989df318ce3732183d32f62aa7b8181463f7e22f\", \"latency_unittests\": \"0820093189f902f80ef9e93ca288e35da493953d\", \"libjingle_xmpp_unittests\": \"67e57edbbee16221cd88104a1677f3a505826e4d\", \"liburlpattern_unittests\": \"21d7452a8e6a4f50711b8296ca3a6463b73b4281\", \"media_blink_unittests\": \"19474394055692d22daf2b00c6aca50cd43e7d46\", \"media_unittests\": \"277ccca19ef922dec0ede8b730a4287fc7982450\", \"message_center_unittests\": \"1456840b471065ed17a44f53bca22b58d400cdf9\", \"midi_unittests\": \"16998c522bd56abafe2320aac6b043f9ca20cc6c\", \"mojo_core_unittests\": \"2648ad5bfe3caed0841fa490e5bc827d50fcfb4f\", \"mojo_unittests\": \"c3eb4fe1022e09329949cf3571d032f0a033a216\", \"nacl_helper_nonsfi_unittests\": \"f43c38c00ffcf98ba30635020f2c472cf832fd03\", \"nacl_loader_unittests\": \"dd62fcfa348ae4d9345c9ac5e599f68795cda14c\", \"native_theme_unittests\": \"6277770c91d5686d2bd933acacbe44d9626746db\", \"net_unittests\": \"1705c49fab6f1d6ea89779d9fc45560d230b121e\", \"ozone_gl_unittests\": \"dd2ca81b09865e1a3a493e6c3c079a8663ad2390\", \"ozone_unittests\": \"210920ba7d999e89a29b4a667b8463a2f385240c\", \"ozone_x11_unittests\": \"749bef696cc064ba71d55305a41995b7a3375edb\", \"pdf_unittests\": \"bdee45a8a515aa9d6ce0965b440d123ac0c24d8a\", \"perfetto_unittests\": \"9054041a44ac3915bcccb1b304aa790f23963f38\", \"ppapi_unittests\": \"7ea997158c16355dc8bd21a04a2801b2769a7875\", \"printing_unittests\": \"0fe19ac0e224e5f0f0a3feea5903b3acaf269c72\", \"remoting_unittests\": \"00268f4c7591fb7e53c296871d060afce9451025\", \"sandbox_linux_unittests\": \"c822f47da4a486e96078b440f85a010b36019a35\", \"service_manager_unittests\": \"3d970be6e72ae47981f61201e1c83ac2ae4274b6\", \"services_unittests\": \"79a5d8b250bb971c42784f38fd84f388d8e0e577\", \"shell_dialogs_unittests\": \"73031d82fa7d1206952936e2a15b025c737b1b49\", \"shell_encryption_unittests\": \"cec6fbaf56e6369f8b10f8e651650bea71202dc4\", \"skia_unittests\": \"aefff4d786d0ccfd9c4888a6096ac7e4ce733fd4\", \"snapshot_unittests\": \"723118e334fc35a7fd49c342ba3465cf50ad8945\", \"sql_unittests\": \"8b88791518771050487657d2438ca7032746b744\", \"storage_unittests\": \"b32879ccd04166375acbb515d6524e84c984125f\", \"sync_integration_tests\": \"ed692ed2633044c345f859da5fae8ed7f183794b\", \"traffic_annotation_auditor_unittests\": \"dc1c0070dc2471527493ec09b31ec10391ab5b38\", \"ui_base_unittests\": \"fca5610835ba6f3749e9a23d0089cb3f31cb224e\", \"ui_chromeos_unittests\": \"3f4c2f33fbd864c3ce9e8011a3f29a244a289b54\", \"ui_touch_selection_unittests\": \"4c93bc91f3da1f95e533dbb13e2744ab8a309aa2\", \"unit_tests\": \"9872ee17ebe442a6f03d8dce781780dec310bbaa\", \"url_unittests\": \"94ba90b4e011559769b0c60bdd4379ecbca94aa0\", \"usage_time_limit_unittests\": \"f5bad110dc53bfc4e4b50e4dc1bedc286b78a031\", \"views_unittests\": \"b8c54c308a1d4d22719452b1e66dfc1e736219a5\", \"viz_unittests\": \"16108ccc866ced6c5d5afcb4cf72ca94b4277561\", \"wm_unittests\": \"e11d6d05f9ef34dbd7b44e4ca3366e0219b71ed2\", \"wtf_unittests\": \"140fd585e8d6e6f7b599b350b6bd2327a9245956\", \"zlib_unittests\": \"32b147e9f1a5403fe22ab5707f3d626b88bbb99e\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_304607b978b8f4bcd63bac0f543c3a69f6b4c7cf202dcd2d3c5b8d4a70be201e_v2\", \"builder_3f701152d865ce3ec8feb15f973214ad980aeace5cbda24477548a965269fca6_v2\", \"builder_5018db700e530f8e7ae860b5b3feab2b02d3dedf1bbd3e704c6c59fde1b308dd_v2\", \"builder_76783dd5c2a60df34bfc78d9ceb12670a24fdda597cce6f387a1a4911c7cdf2d_v2\", \"builder_eb75bb97ad9a82e6e51bc242be3605b13562b7c1ffaba99d94159b9b70e03009_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-62-043q\"], \"image\": [\"chrome-xenial-21010300-f0aeabbfea7\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"e2-standard-8\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-16\", \"Ubuntu-16.04\", \"Ubuntu-16.04.6\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.12\"], \"server_version\": [\"5657-0417a3f\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-east\", \"us-east1\", \"us-east1-d\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1610248193397744",
"status": "COMPLETED",
"status_changed_ts": "1610254486345768",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-dbg/22134",
"builder:linux-chromeos-dbg",
"buildset:commit/git/487ebc5018e36bf394c86085c058620a0f71c86b",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/487ebc5018e36bf394c86085c058620a0f71c86b",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9023959228494921760",
"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/8858529166410106528/+/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:5102ea8924fe9610",
"user_agent:luci-scheduler"
],
"updated_ts": "1610254486354978",
"url": "https://ci.chromium.org/b/8858529166410106528",
"utcnow_ts": "1610254487619138"
}
}
[04:54:47.691] Invocation finished in 2h33m33.996863536s with status SUCCEEDED