[05:11:48.165] New invocation is queued and will start shortly
[05:11:49.472] Starting the invocation (attempt 1)
[05:11:49.577] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[05:11:49.577] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[05:11:49.577] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9088362940003873984",
"parameters_json": "{\"builder_name\":\"Linux CFI\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src.git\",\"revision\":\"e26756e70b44b084601b363b0544ce0fece78464\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:Linux CFI",
"scheduler_invocation_id:9088362940003873984",
"scheduler_job_id:chromium/Linux CFI",
"user_agent:luci-scheduler",
"buildset:commit/git/e26756e70b44b084601b363b0544ce0fece78464",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/e26756e70b44b084601b363b0544ce0fece78464",
"gitiles_ref:refs/heads/master"
]
}
[05:11:51.202] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "AUTO",
"created_by": "user:luci-scheduler@appspot.gserviceaccount.com",
"created_ts": "1548825109866976",
"id": "8922932877554989472",
"lease_expiration_ts": "1548943910959756",
"lease_key": "196045893",
"parameters_json": "{\"builder_name\": \"Linux CFI\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src.git\", \"revision\": \"e26756e70b44b084601b363b0544ce0fece78464\"}}",
"project": "chromium",
"result_details_json": "null",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1548825111063768",
"tags": [
"build_address:luci.chromium.ci/Linux CFI/12584",
"builder:Linux CFI",
"buildset:commit/git/e26756e70b44b084601b363b0544ce0fece78464",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/e26756e70b44b084601b363b0544ce0fece78464",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9088362940003873984",
"scheduler_job_id:chromium/Linux CFI",
"swarming_dimension:builder:Linux CFI",
"swarming_dimension:caches:builder_4546ef179f50eb727f19fe6abd7705a7b8921ff8263e4e2e8e2644dd615ef1a7_v2",
"swarming_dimension:cores:32",
"swarming_dimension:cpu:x86-64",
"swarming_dimension:os:Ubuntu-14.04",
"swarming_dimension:pool:luci.chromium.ci",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:build_address:luci.chromium.ci/Linux CFI/12584",
"swarming_tag:buildbucket_bucket:chromium/ci",
"swarming_tag:buildbucket_build_id:8922932877554989472",
"swarming_tag:buildbucket_hostname:cr-buildbucket.appspot.com",
"swarming_tag:buildbucket_template_canary:0",
"swarming_tag:buildbucket_template_revision:01134cf47e8a2d5d7cea5ec1232ca64ed2f16a5c",
"swarming_tag:builder:Linux CFI",
"swarming_tag:buildset:commit/git/e26756e70b44b084601b363b0544ce0fece78464",
"swarming_tag:buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/e26756e70b44b084601b363b0544ce0fece78464",
"swarming_tag:caches:builder_4546ef179f50eb727f19fe6abd7705a7b8921ff8263e4e2e8e2644dd615ef1a7_v2",
"swarming_tag:cores:32",
"swarming_tag:cpu:x86-64",
"swarming_tag:gitiles_ref:refs/heads/master",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8922932877554989472/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:os:Ubuntu-14.04",
"swarming_tag:pool:luci.chromium.ci",
"swarming_tag:priority:30",
"swarming_tag:recipe_name:chromium",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_tag:scheduler_invocation_id:9088362940003873984",
"swarming_tag:scheduler_job_id:chromium/Linux CFI",
"swarming_tag:service_account:chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"swarming_tag:swarming.pool.template:skip",
"swarming_tag:swarming.pool.version:4c16436c5a2d36c0d0298bf90c374ab67f50af8c",
"swarming_tag:user:None",
"swarming_tag:user_agent:luci-scheduler",
"swarming_tag:vpython:native-python-wrapper",
"swarming_task_id:42b5fd3097c08e10",
"user_agent:luci-scheduler"
],
"updated_ts": "1548825111063783",
"url": "https://ci.chromium.org/b/8922932877554989472",
"utcnow_ts": "1548825111189216"
}
}
[05:11:51.202] Task URL: https://ci.chromium.org/b/8922932877554989472
[05:11:51.202] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:2:0) after 1m0s
[05:12:41.663] Received PubSub notification, asking Buildbucket for the build status
[05:12:41.711] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:12:51.223] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:2:0)
[05:12:51.223] Timer tick, asking Buildbucket for the build status
[05:12:51.397] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:12:51.397] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:4:0) after 1m0s
[05:13:51.412] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:4:0)
[05:13:51.413] Timer tick, asking Buildbucket for the build status
[05:13:51.573] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:13:51.573] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:5:0) after 1m0s
[05:14:51.655] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:5:0)
[05:14:51.655] Timer tick, asking Buildbucket for the build status
[05:14:51.789] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:14:51.789] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:6:0) after 1m0s
[05:15:51.822] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:6:0)
[05:15:51.822] Timer tick, asking Buildbucket for the build status
[05:15:51.884] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:15:51.884] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:7:0) after 1m0s
[05:16:51.908] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:7:0)
[05:16:51.908] Timer tick, asking Buildbucket for the build status
[05:16:51.940] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:16:51.941] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:8:0) after 1m0s
[05:17:51.966] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:8:0)
[05:17:51.966] Timer tick, asking Buildbucket for the build status
[05:17:52.132] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:17:52.132] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:9:0) after 1m0s
[05:18:52.188] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:9:0)
[05:18:52.188] Timer tick, asking Buildbucket for the build status
[05:18:52.349] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:18:52.349] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:10:0) after 1m0s
[05:19:52.388] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:10:0)
[05:19:52.388] Timer tick, asking Buildbucket for the build status
[05:19:52.480] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:19:52.480] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:11:0) after 1m0s
[05:20:52.829] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:11:0)
[05:20:52.829] Timer tick, asking Buildbucket for the build status
[05:20:53.009] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:20:53.009] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:12:0) after 1m0s
[05:21:53.033] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:12:0)
[05:21:53.033] Timer tick, asking Buildbucket for the build status
[05:21:53.106] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:21:53.106] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:13:0) after 1m0s
[05:22:53.133] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:13:0)
[05:22:53.133] Timer tick, asking Buildbucket for the build status
[05:22:53.220] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:22:53.220] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:14:0) after 1m0s
[05:23:53.460] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:14:0)
[05:23:53.460] Timer tick, asking Buildbucket for the build status
[05:23:54.013] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:23:54.013] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:15:0) after 1m0s
[05:24:54.033] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:15:0)
[05:24:54.033] Timer tick, asking Buildbucket for the build status
[05:24:54.074] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:24:54.074] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:16:0) after 1m0s
[05:25:54.151] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:16:0)
[05:25:54.151] Timer tick, asking Buildbucket for the build status
[05:25:54.211] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:25:54.211] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:17:0) after 1m0s
[05:26:54.255] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:17:0)
[05:26:54.255] Timer tick, asking Buildbucket for the build status
[05:26:54.305] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:26:54.305] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:18:0) after 1m0s
[05:27:54.334] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:18:0)
[05:27:54.334] Timer tick, asking Buildbucket for the build status
[05:27:54.389] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:27:54.389] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:19:0) after 1m0s
[05:28:54.437] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:19:0)
[05:28:54.438] Timer tick, asking Buildbucket for the build status
[05:28:54.603] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:28:54.603] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:20:0) after 1m0s
[05:29:54.639] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:20:0)
[05:29:54.639] Timer tick, asking Buildbucket for the build status
[05:29:54.690] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:29:54.690] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:21:0) after 1m0s
[05:30:54.710] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:21:0)
[05:30:54.710] Timer tick, asking Buildbucket for the build status
[05:30:54.744] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:30:54.745] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:22:0) after 1m0s
[05:31:54.764] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:22:0)
[05:31:54.764] Timer tick, asking Buildbucket for the build status
[05:31:54.865] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:31:54.865] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:23:0) after 1m0s
[05:32:54.885] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:23:0)
[05:32:54.885] Timer tick, asking Buildbucket for the build status
[05:32:54.939] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:32:54.939] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:24:0) after 1m0s
[05:33:54.964] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:24:0)
[05:33:54.964] Timer tick, asking Buildbucket for the build status
[05:33:55.160] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:33:55.160] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:25:0) after 1m0s
[05:34:55.194] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:25:0)
[05:34:55.194] Timer tick, asking Buildbucket for the build status
[05:34:55.255] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:34:55.255] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:26:0) after 1m0s
[05:35:55.277] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:26:0)
[05:35:55.277] Timer tick, asking Buildbucket for the build status
[05:35:55.315] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:35:55.315] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:27:0) after 1m0s
[05:36:55.353] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:27:0)
[05:36:55.353] Timer tick, asking Buildbucket for the build status
[05:36:55.391] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:36:55.391] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:28:0) after 1m0s
[05:37:55.413] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:28:0)
[05:37:55.413] Timer tick, asking Buildbucket for the build status
[05:37:55.496] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:37:55.496] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:29:0) after 1m0s
[05:38:55.528] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:29:0)
[05:38:55.528] Timer tick, asking Buildbucket for the build status
[05:38:55.567] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:38:55.567] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:30:0) after 1m0s
[05:39:55.586] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:30:0)
[05:39:55.586] Timer tick, asking Buildbucket for the build status
[05:39:55.637] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:39:55.637] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:31:0) after 1m0s
[05:40:55.675] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:31:0)
[05:40:55.675] Timer tick, asking Buildbucket for the build status
[05:40:55.738] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:40:55.738] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:32:0) after 1m0s
[05:41:55.760] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:32:0)
[05:41:55.760] Timer tick, asking Buildbucket for the build status
[05:41:55.794] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:41:55.794] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:33:0) after 1m0s
[05:42:55.814] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:33:0)
[05:42:55.814] Timer tick, asking Buildbucket for the build status
[05:42:55.986] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:42:55.986] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:34:0) after 1m0s
[05:43:56.007] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:34:0)
[05:43:56.008] Timer tick, asking Buildbucket for the build status
[05:43:56.049] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:43:56.049] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:35:0) after 1m0s
[05:44:56.067] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:35:0)
[05:44:56.067] Timer tick, asking Buildbucket for the build status
[05:44:56.140] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:44:56.140] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:36:0) after 1m0s
[05:45:56.176] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:36:0)
[05:45:56.176] Timer tick, asking Buildbucket for the build status
[05:45:56.234] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:45:56.234] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:37:0) after 1m0s
[05:46:56.294] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:37:0)
[05:46:56.294] Timer tick, asking Buildbucket for the build status
[05:46:56.368] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:46:56.368] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:38:0) after 1m0s
[05:47:56.401] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:38:0)
[05:47:56.401] Timer tick, asking Buildbucket for the build status
[05:47:56.459] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:47:56.459] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:39:0) after 1m0s
[05:48:56.481] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:39:0)
[05:48:56.481] Timer tick, asking Buildbucket for the build status
[05:48:56.531] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:48:56.531] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:40:0) after 1m0s
[05:49:56.553] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:40:0)
[05:49:56.553] Timer tick, asking Buildbucket for the build status
[05:49:56.702] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:49:56.702] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:41:0) after 1m0s
[05:50:56.726] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:41:0)
[05:50:56.726] Timer tick, asking Buildbucket for the build status
[05:50:56.778] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:50:56.778] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:42:0) after 1m0s
[05:51:56.798] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:42:0)
[05:51:56.798] Timer tick, asking Buildbucket for the build status
[05:51:56.832] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:51:56.832] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:43:0) after 1m0s
[05:52:56.987] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:43:0)
[05:52:56.987] Timer tick, asking Buildbucket for the build status
[05:52:57.063] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:52:57.063] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:44:0) after 1m0s
[05:53:57.085] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:44:0)
[05:53:57.085] Timer tick, asking Buildbucket for the build status
[05:53:57.163] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:53:57.163] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:45:0) after 1m0s
[05:54:57.199] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:45:0)
[05:54:57.199] Timer tick, asking Buildbucket for the build status
[05:54:57.232] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:54:57.232] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:46:0) after 1m0s
[05:55:57.254] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:46:0)
[05:55:57.254] Timer tick, asking Buildbucket for the build status
[05:55:57.333] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:55:57.333] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:47:0) after 1m0s
[05:56:57.358] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:47:0)
[05:56:57.358] Timer tick, asking Buildbucket for the build status
[05:56:57.494] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:56:57.494] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:48:0) after 1m0s
[05:57:57.540] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:48:0)
[05:57:57.540] Timer tick, asking Buildbucket for the build status
[05:57:57.578] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:57:57.578] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:49:0) after 1m0s
[05:58:57.603] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:49:0)
[05:58:57.603] Timer tick, asking Buildbucket for the build status
[05:58:57.655] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:58:57.655] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:50:0) after 1m0s
[05:59:57.675] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:50:0)
[05:59:57.675] Timer tick, asking Buildbucket for the build status
[05:59:57.797] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:59:57.797] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:51:0) after 1m0s
[06:00:57.818] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:51:0)
[06:00:57.818] Timer tick, asking Buildbucket for the build status
[06:00:57.873] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:00:57.873] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:52:0) after 1m0s
[06:01:57.896] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:52:0)
[06:01:57.896] Timer tick, asking Buildbucket for the build status
[06:01:57.986] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:01:57.986] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:53:0) after 1m0s
[06:02:58.008] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:53:0)
[06:02:58.008] Timer tick, asking Buildbucket for the build status
[06:02:58.057] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:02:58.057] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:54:0) after 1m0s
[06:03:58.128] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:54:0)
[06:03:58.128] Timer tick, asking Buildbucket for the build status
[06:03:58.258] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:03:58.258] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:55:0) after 1m0s
[06:04:58.280] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:55:0)
[06:04:58.280] Timer tick, asking Buildbucket for the build status
[06:04:58.345] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:04:58.345] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:56:0) after 1m0s
[06:05:58.465] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:56:0)
[06:05:58.465] Timer tick, asking Buildbucket for the build status
[06:05:58.504] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:05:58.504] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:57:0) after 1m0s
[06:06:58.588] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:57:0)
[06:06:58.588] Timer tick, asking Buildbucket for the build status
[06:06:58.631] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:06:58.631] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:58:0) after 1m0s
[06:07:58.701] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:58:0)
[06:07:58.701] Timer tick, asking Buildbucket for the build status
[06:07:58.862] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:07:58.862] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:59:0) after 1m0s
[06:08:58.884] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:59:0)
[06:08:58.884] Timer tick, asking Buildbucket for the build status
[06:08:58.924] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:08:58.924] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:60:0) after 1m0s
[06:09:58.948] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:60:0)
[06:09:58.948] Timer tick, asking Buildbucket for the build status
[06:09:59.165] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:09:59.166] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:61:0) after 1m0s
[06:10:59.188] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:61:0)
[06:10:59.188] Timer tick, asking Buildbucket for the build status
[06:10:59.252] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:10:59.252] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:62:0) after 1m0s
[06:11:59.289] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:62:0)
[06:11:59.289] Timer tick, asking Buildbucket for the build status
[06:11:59.370] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:11:59.370] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:63:0) after 1m0s
[06:12:59.397] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:63:0)
[06:12:59.397] Timer tick, asking Buildbucket for the build status
[06:12:59.436] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:12:59.436] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:64:0) after 1m0s
[06:13:59.456] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:64:0)
[06:13:59.456] Timer tick, asking Buildbucket for the build status
[06:13:59.549] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:13:59.549] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:65:0) after 1m0s
[06:14:59.587] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:65:0)
[06:14:59.587] Timer tick, asking Buildbucket for the build status
[06:14:59.671] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:14:59.671] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:66:0) after 1m0s
[06:15:59.693] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:66:0)
[06:15:59.693] Timer tick, asking Buildbucket for the build status
[06:15:59.771] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:15:59.771] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:67:0) after 1m0s
[06:16:59.903] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:67:0)
[06:16:59.903] Timer tick, asking Buildbucket for the build status
[06:16:59.937] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:16:59.937] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:68:0) after 1m0s
[06:17:59.963] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:68:0)
[06:17:59.963] Timer tick, asking Buildbucket for the build status
[06:18:00.020] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:18:00.020] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:69:0) after 1m0s
[06:19:00.093] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:69:0)
[06:19:00.093] Timer tick, asking Buildbucket for the build status
[06:19:00.209] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:19:00.209] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:70:0) after 1m0s
[06:20:00.261] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:70:0)
[06:20:00.261] Timer tick, asking Buildbucket for the build status
[06:20:00.382] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:20:00.382] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:71:0) after 1m0s
[06:21:00.467] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:71:0)
[06:21:00.467] Timer tick, asking Buildbucket for the build status
[06:21:00.508] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:21:00.508] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:72:0) after 1m0s
[06:22:00.540] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:72:0)
[06:22:00.540] Timer tick, asking Buildbucket for the build status
[06:22:00.689] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:22:00.689] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:73:0) after 1m0s
[06:23:00.713] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:73:0)
[06:23:00.713] Timer tick, asking Buildbucket for the build status
[06:23:00.775] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:23:00.775] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:74:0) after 1m0s
[06:24:00.797] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:74:0)
[06:24:00.797] Timer tick, asking Buildbucket for the build status
[06:24:00.832] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:24:00.832] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:75:0) after 1m0s
[06:25:00.855] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:75:0)
[06:25:00.855] Timer tick, asking Buildbucket for the build status
[06:25:00.962] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:25:00.963] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:76:0) after 1m0s
[06:26:00.990] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:76:0)
[06:26:00.990] Timer tick, asking Buildbucket for the build status
[06:26:01.033] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:26:01.033] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:77:0) after 1m0s
[06:27:01.056] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:77:0)
[06:27:01.056] Timer tick, asking Buildbucket for the build status
[06:27:01.111] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:27:01.111] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:78:0) after 1m0s
[06:28:01.138] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:78:0)
[06:28:01.138] Timer tick, asking Buildbucket for the build status
[06:28:01.174] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:28:01.174] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:79:0) after 1m0s
[06:29:01.194] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:79:0)
[06:29:01.194] Timer tick, asking Buildbucket for the build status
[06:29:01.268] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:29:01.268] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:80:0) after 1m0s
[06:30:01.290] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:80:0)
[06:30:01.290] Timer tick, asking Buildbucket for the build status
[06:30:01.385] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:30:01.385] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:81:0) after 1m0s
[06:31:01.422] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:81:0)
[06:31:01.422] Timer tick, asking Buildbucket for the build status
[06:31:01.465] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:31:01.465] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:82:0) after 1m0s
[06:32:01.487] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:82:0)
[06:32:01.487] Timer tick, asking Buildbucket for the build status
[06:32:01.543] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:32:01.543] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:83:0) after 1m0s
[06:33:01.563] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:83:0)
[06:33:01.563] Timer tick, asking Buildbucket for the build status
[06:33:01.616] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:33:01.616] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:84:0) after 1m0s
[06:34:01.643] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:84:0)
[06:34:01.643] Timer tick, asking Buildbucket for the build status
[06:34:01.699] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:34:01.699] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:85:0) after 1m0s
[06:35:01.723] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:85:0)
[06:35:01.723] Timer tick, asking Buildbucket for the build status
[06:35:01.790] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:35:01.790] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:86:0) after 1m0s
[06:36:01.818] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:86:0)
[06:36:01.818] Timer tick, asking Buildbucket for the build status
[06:36:01.936] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:36:01.936] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:87:0) after 1m0s
[06:37:01.993] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:87:0)
[06:37:01.993] Timer tick, asking Buildbucket for the build status
[06:37:02.049] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:37:02.049] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:88:0) after 1m0s
[06:38:02.071] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:88:0)
[06:38:02.071] Timer tick, asking Buildbucket for the build status
[06:38:02.164] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:38:02.164] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:89:0) after 1m0s
[06:39:02.193] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:89:0)
[06:39:02.193] Timer tick, asking Buildbucket for the build status
[06:39:02.228] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:39:02.228] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:90:0) after 1m0s
[06:40:02.254] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:90:0)
[06:40:02.254] Timer tick, asking Buildbucket for the build status
[06:40:02.349] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:40:02.349] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:91:0) after 1m0s
[06:41:02.383] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:91:0)
[06:41:02.383] Timer tick, asking Buildbucket for the build status
[06:41:02.415] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:41:02.415] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:92:0) after 1m0s
[06:42:02.441] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:92:0)
[06:42:02.441] Timer tick, asking Buildbucket for the build status
[06:42:02.511] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:42:02.511] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:93:0) after 1m0s
[06:43:02.741] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:93:0)
[06:43:02.741] Timer tick, asking Buildbucket for the build status
[06:43:02.777] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:43:02.777] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:94:0) after 1m0s
[06:44:02.806] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:94:0)
[06:44:02.806] Timer tick, asking Buildbucket for the build status
[06:44:02.840] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:44:02.840] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:95:0) after 1m0s
[06:45:02.877] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:95:0)
[06:45:02.877] Timer tick, asking Buildbucket for the build status
[06:45:02.963] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:45:02.963] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:96:0) after 1m0s
[06:46:03.022] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:96:0)
[06:46:03.022] Timer tick, asking Buildbucket for the build status
[06:46:03.106] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:46:03.106] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:97:0) after 1m0s
[06:47:03.175] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:97:0)
[06:47:03.175] Timer tick, asking Buildbucket for the build status
[06:47:03.241] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:47:03.241] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:98:0) after 1m0s
[06:48:03.281] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:98:0)
[06:48:03.281] Timer tick, asking Buildbucket for the build status
[06:48:03.368] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:48:03.368] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:99:0) after 1m0s
[06:49:03.390] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:99:0)
[06:49:03.390] Timer tick, asking Buildbucket for the build status
[06:49:03.508] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:49:03.509] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:100:0) after 1m0s
[06:50:03.549] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:100:0)
[06:50:03.549] Timer tick, asking Buildbucket for the build status
[06:50:03.694] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:50:03.694] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:101:0) after 1m0s
[06:51:03.714] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:101:0)
[06:51:03.714] Timer tick, asking Buildbucket for the build status
[06:51:03.772] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:51:03.772] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:102:0) after 1m0s
[06:52:03.794] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:102:0)
[06:52:03.794] Timer tick, asking Buildbucket for the build status
[06:52:03.826] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:52:03.826] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:103:0) after 1m0s
[06:53:03.847] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:103:0)
[06:53:03.847] Timer tick, asking Buildbucket for the build status
[06:53:03.959] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:53:03.959] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:104:0) after 1m0s
[06:54:04.000] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:104:0)
[06:54:04.000] Timer tick, asking Buildbucket for the build status
[06:54:04.037] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:54:04.037] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:105:0) after 1m0s
[06:55:04.077] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:105:0)
[06:55:04.077] Timer tick, asking Buildbucket for the build status
[06:55:04.210] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:55:04.210] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:106:0) after 1m0s
[06:56:04.252] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:106:0)
[06:56:04.252] Timer tick, asking Buildbucket for the build status
[06:56:04.298] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:56:04.298] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:107:0) after 1m0s
[06:57:04.322] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:107:0)
[06:57:04.322] Timer tick, asking Buildbucket for the build status
[06:57:04.376] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:57:04.376] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:108:0) after 1m0s
[06:58:04.436] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:108:0)
[06:58:04.436] Timer tick, asking Buildbucket for the build status
[06:58:04.482] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:58:04.482] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:109:0) after 1m0s
[06:59:04.580] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:109:0)
[06:59:04.580] Timer tick, asking Buildbucket for the build status
[06:59:04.615] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:59:04.615] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:110:0) after 1m0s
[07:00:04.653] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:110:0)
[07:00:04.653] Timer tick, asking Buildbucket for the build status
[07:00:04.742] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:00:04.742] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:111:0) after 1m0s
[07:01:04.799] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:111:0)
[07:01:04.799] Timer tick, asking Buildbucket for the build status
[07:01:04.989] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:01:04.989] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:112:0) after 1m0s
[07:02:05.021] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:112:0)
[07:02:05.021] Timer tick, asking Buildbucket for the build status
[07:02:05.099] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:02:05.099] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:113:0) after 1m0s
[07:03:05.164] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:113:0)
[07:03:05.164] Timer tick, asking Buildbucket for the build status
[07:03:05.212] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:03:05.212] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:114:0) after 1m0s
[07:04:05.241] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:114:0)
[07:04:05.241] Timer tick, asking Buildbucket for the build status
[07:04:05.302] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:04:05.302] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:115:0) after 1m0s
[07:05:05.328] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:115:0)
[07:05:05.328] Timer tick, asking Buildbucket for the build status
[07:05:05.368] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:05:05.368] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:116:0) after 1m0s
[07:06:05.391] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:116:0)
[07:06:05.391] Timer tick, asking Buildbucket for the build status
[07:06:05.483] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:06:05.483] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:117:0) after 1m0s
[07:07:05.509] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:117:0)
[07:07:05.509] Timer tick, asking Buildbucket for the build status
[07:07:05.790] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:07:05.790] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:118:0) after 1m0s
[07:08:05.816] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:118:0)
[07:08:05.816] Timer tick, asking Buildbucket for the build status
[07:08:05.940] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:08:05.940] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:119:0) after 1m0s
[07:09:05.969] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:119:0)
[07:09:05.969] Timer tick, asking Buildbucket for the build status
[07:09:06.035] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:09:06.035] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:120:0) after 1m0s
[07:10:06.079] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:120:0)
[07:10:06.079] Timer tick, asking Buildbucket for the build status
[07:10:06.180] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:10:06.180] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:121:0) after 1m0s
[07:11:06.269] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:121:0)
[07:11:06.269] Timer tick, asking Buildbucket for the build status
[07:11:06.313] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:11:06.313] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:122:0) after 1m0s
[07:12:06.353] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:122:0)
[07:12:06.353] Timer tick, asking Buildbucket for the build status
[07:12:06.470] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:12:06.470] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:123:0) after 1m0s
[07:13:06.495] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:123:0)
[07:13:06.495] Timer tick, asking Buildbucket for the build status
[07:13:06.602] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:13:06.602] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:124:0) after 1m0s
[07:14:06.632] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:124:0)
[07:14:06.632] Timer tick, asking Buildbucket for the build status
[07:14:06.674] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:14:06.674] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:125:0) after 1m0s
[07:15:06.701] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:125:0)
[07:15:06.701] Timer tick, asking Buildbucket for the build status
[07:15:06.877] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:15:06.877] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:126:0) after 1m0s
[07:16:06.929] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:126:0)
[07:16:06.929] Timer tick, asking Buildbucket for the build status
[07:16:06.967] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:16:06.967] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:127:0) after 1m0s
[07:17:06.992] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:127:0)
[07:17:06.992] Timer tick, asking Buildbucket for the build status
[07:17:07.023] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:17:07.024] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:128:0) after 1m0s
[07:18:07.068] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:128:0)
[07:18:07.068] Timer tick, asking Buildbucket for the build status
[07:18:07.203] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:18:07.203] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:129:0) after 1m0s
[07:19:07.227] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:129:0)
[07:19:07.227] Timer tick, asking Buildbucket for the build status
[07:19:07.339] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:19:07.339] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:130:0) after 1m0s
[07:20:07.373] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:130:0)
[07:20:07.373] Timer tick, asking Buildbucket for the build status
[07:20:07.423] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:20:07.423] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:131:0) after 1m0s
[07:21:07.451] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:131:0)
[07:21:07.451] Timer tick, asking Buildbucket for the build status
[07:21:07.487] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:21:07.487] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:132:0) after 1m0s
[07:22:07.529] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:132:0)
[07:22:07.529] Timer tick, asking Buildbucket for the build status
[07:22:07.616] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:22:07.616] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:133:0) after 1m0s
[07:23:07.663] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:133:0)
[07:23:07.663] Timer tick, asking Buildbucket for the build status
[07:23:07.980] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:23:07.980] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:134:0) after 1m0s
[07:24:08.003] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:134:0)
[07:24:08.003] Timer tick, asking Buildbucket for the build status
[07:24:08.129] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:24:08.129] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:135:0) after 1m0s
[07:25:08.155] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:135:0)
[07:25:08.156] Timer tick, asking Buildbucket for the build status
[07:25:08.348] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:25:08.348] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:136:0) after 1m0s
[07:26:08.442] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:136:0)
[07:26:08.442] Timer tick, asking Buildbucket for the build status
[07:26:08.500] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:26:08.500] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:137:0) after 1m0s
[07:27:08.564] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:137:0)
[07:27:08.564] Timer tick, asking Buildbucket for the build status
[07:27:08.666] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:27:08.666] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:138:0) after 1m0s
[07:28:08.702] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:138:0)
[07:28:08.702] Timer tick, asking Buildbucket for the build status
[07:28:08.749] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:28:08.749] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:139:0) after 1m0s
[07:29:08.780] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:139:0)
[07:29:08.780] Timer tick, asking Buildbucket for the build status
[07:29:08.830] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:29:08.830] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:140:0) after 1m0s
[07:30:08.875] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:140:0)
[07:30:08.875] Timer tick, asking Buildbucket for the build status
[07:30:08.918] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:30:08.918] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:141:0) after 1m0s
[07:31:09.055] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:141:0)
[07:31:09.055] Timer tick, asking Buildbucket for the build status
[07:31:09.133] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:31:09.133] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:142:0) after 1m0s
[07:32:09.156] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:142:0)
[07:32:09.156] Timer tick, asking Buildbucket for the build status
[07:32:09.195] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:32:09.195] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:143:0) after 1m0s
[07:33:09.216] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:143:0)
[07:33:09.216] Timer tick, asking Buildbucket for the build status
[07:33:09.370] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:33:09.370] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:144:0) after 1m0s
[07:34:09.359] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:144:0)
[07:34:09.359] Timer tick, asking Buildbucket for the build status
[07:34:09.396] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:34:09.396] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:145:0) after 1m0s
[07:35:09.482] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:145:0)
[07:35:09.482] Timer tick, asking Buildbucket for the build status
[07:35:09.568] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:35:09.568] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:146:0) after 1m0s
[07:36:09.593] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:146:0)
[07:36:09.593] Timer tick, asking Buildbucket for the build status
[07:36:09.625] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:36:09.625] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:147:0) after 1m0s
[07:37:09.707] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:147:0)
[07:37:09.707] Timer tick, asking Buildbucket for the build status
[07:37:09.816] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:37:09.816] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:148:0) after 1m0s
[07:38:09.846] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:148:0)
[07:38:09.846] Timer tick, asking Buildbucket for the build status
[07:38:09.948] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:38:09.948] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:149:0) after 1m0s
[07:39:10.026] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:149:0)
[07:39:10.026] Timer tick, asking Buildbucket for the build status
[07:39:10.135] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:39:10.135] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:150:0) after 1m0s
[07:40:10.186] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:150:0)
[07:40:10.186] Timer tick, asking Buildbucket for the build status
[07:40:10.270] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:40:10.270] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:151:0) after 1m0s
[07:41:10.299] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:151:0)
[07:41:10.299] Timer tick, asking Buildbucket for the build status
[07:41:10.405] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:41:10.405] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:152:0) after 1m0s
[07:42:10.485] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:152:0)
[07:42:10.485] Timer tick, asking Buildbucket for the build status
[07:42:10.601] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:42:10.601] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:153:0) after 1m0s
[07:43:10.661] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:153:0)
[07:43:10.661] Timer tick, asking Buildbucket for the build status
[07:43:10.862] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:43:10.862] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:154:0) after 1m0s
[07:44:10.965] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:154:0)
[07:44:10.965] Timer tick, asking Buildbucket for the build status
[07:44:10.997] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:44:10.997] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:155:0) after 1m0s
[07:45:11.145] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:155:0)
[07:45:11.145] Timer tick, asking Buildbucket for the build status
[07:45:11.184] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:45:11.184] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:156:0) after 1m0s
[07:46:11.206] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:156:0)
[07:46:11.206] Timer tick, asking Buildbucket for the build status
[07:46:11.254] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:46:11.254] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:157:0) after 1m0s
[07:47:11.280] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:157:0)
[07:47:11.280] Timer tick, asking Buildbucket for the build status
[07:47:11.314] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:47:11.314] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:158:0) after 1m0s
[07:48:11.317] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:158:0)
[07:48:11.317] Timer tick, asking Buildbucket for the build status
[07:48:11.461] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:48:11.461] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:159:0) after 1m0s
[07:49:11.486] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:159:0)
[07:49:11.486] Timer tick, asking Buildbucket for the build status
[07:49:11.546] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:49:11.546] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:160:0) after 1m0s
[07:50:11.643] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:160:0)
[07:50:11.644] Timer tick, asking Buildbucket for the build status
[07:50:11.693] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:50:11.693] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:161:0) after 1m0s
[07:51:11.796] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:161:0)
[07:51:11.796] Timer tick, asking Buildbucket for the build status
[07:51:11.876] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:51:11.876] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:162:0) after 1m0s
[07:52:11.902] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:162:0)
[07:52:11.902] Timer tick, asking Buildbucket for the build status
[07:52:11.954] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:52:11.954] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:163:0) after 1m0s
[07:53:11.978] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:163:0)
[07:53:11.978] Timer tick, asking Buildbucket for the build status
[07:53:12.100] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:53:12.100] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:164:0) after 1m0s
[07:54:12.133] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:164:0)
[07:54:12.134] Timer tick, asking Buildbucket for the build status
[07:54:12.190] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:54:12.190] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:165:0) after 1m0s
[07:55:12.230] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:165:0)
[07:55:12.230] Timer tick, asking Buildbucket for the build status
[07:55:12.351] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:55:12.351] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:166:0) after 1m0s
[07:56:12.378] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:166:0)
[07:56:12.378] Timer tick, asking Buildbucket for the build status
[07:56:12.496] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:56:12.496] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:167:0) after 1m0s
[07:57:12.524] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:167:0)
[07:57:12.524] Timer tick, asking Buildbucket for the build status
[07:57:12.627] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:57:12.627] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:168:0) after 1m0s
[07:58:12.691] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:168:0)
[07:58:12.691] Timer tick, asking Buildbucket for the build status
[07:58:12.739] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:58:12.739] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:169:0) after 1m0s
[07:59:12.780] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:169:0)
[07:59:12.780] Timer tick, asking Buildbucket for the build status
[07:59:12.923] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:59:12.923] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:170:0) after 1m0s
[08:00:12.961] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:170:0)
[08:00:12.961] Timer tick, asking Buildbucket for the build status
[08:00:13.043] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:00:13.043] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:171:0) after 1m0s
[08:01:13.072] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:171:0)
[08:01:13.072] Timer tick, asking Buildbucket for the build status
[08:01:13.127] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:01:13.127] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:172:0) after 1m0s
[08:02:13.245] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:172:0)
[08:02:13.245] Timer tick, asking Buildbucket for the build status
[08:02:13.322] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:02:13.322] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:173:0) after 1m0s
[08:03:13.348] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:173:0)
[08:03:13.348] Timer tick, asking Buildbucket for the build status
[08:03:13.421] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:03:13.421] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:174:0) after 1m0s
[08:04:13.446] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:174:0)
[08:04:13.446] Timer tick, asking Buildbucket for the build status
[08:04:13.541] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:04:13.541] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:175:0) after 1m0s
[08:05:13.577] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:175:0)
[08:05:13.577] Timer tick, asking Buildbucket for the build status
[08:05:13.643] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:05:13.643] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:176:0) after 1m0s
[08:06:13.667] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:176:0)
[08:06:13.667] Timer tick, asking Buildbucket for the build status
[08:06:13.721] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:06:13.721] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:177:0) after 1m0s
[08:07:13.817] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:177:0)
[08:07:13.817] Timer tick, asking Buildbucket for the build status
[08:07:13.885] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:07:13.885] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:178:0) after 1m0s
[08:08:13.961] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:178:0)
[08:08:13.961] Timer tick, asking Buildbucket for the build status
[08:08:14.045] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:08:14.045] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:179:0) after 1m0s
[08:09:14.097] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:179:0)
[08:09:14.097] Timer tick, asking Buildbucket for the build status
[08:09:14.188] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:09:14.188] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:180:0) after 1m0s
[08:10:14.239] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:180:0)
[08:10:14.239] Timer tick, asking Buildbucket for the build status
[08:10:14.294] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:10:14.294] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:181:0) after 1m0s
[08:11:14.404] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:181:0)
[08:11:14.404] Timer tick, asking Buildbucket for the build status
[08:11:14.460] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:11:14.460] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:182:0) after 1m0s
[08:12:14.489] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:182:0)
[08:12:14.489] Timer tick, asking Buildbucket for the build status
[08:12:14.545] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:12:14.545] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:183:0) after 1m0s
[08:13:14.577] Handling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:183:0)
[08:13:14.577] Timer tick, asking Buildbucket for the build status
[08:13:14.647] Build 8922932877554989472: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:13:14.647] Scheduling timer "check-buildbucket-build-status" (chromium/Linux CFI:9088362940003873984:184:0) after 1m0s
[08:13:34.136] Received PubSub notification, asking Buildbucket for the build status
[08:13:34.175] Build 8922932877554989472: status "COMPLETED", result "FAILURE", failure_reason "INFRA_FAILURE", cancelation_reason ""
[08:13:34.175] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "AUTO",
"completed_ts": "1548836012951123",
"created_by": "user:luci-scheduler@appspot.gserviceaccount.com",
"created_ts": "1548825109866976",
"failure_reason": "INFRA_FAILURE",
"id": "8922932877554989472",
"parameters_json": "{\"builder_name\": \"Linux CFI\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src.git\", \"revision\": \"e26756e70b44b084601b363b0544ce0fece78464\"}}",
"project": "chromium",
"result": "FAILURE",
"result_details_json": "{\"ui\": {\"info\": \"\"}, \"swarming\": {\"bot_dimensions\": {\"gce\": [\"1\"], \"machine_type\": [\"n1-standard-32\"], \"inside_docker\": [\"0\"], \"python\": [\"2.7.6\"], \"builder\": [\"Linux CFI\"], \"kvm\": [\"1\"], \"id\": [\"swarm787-c4\"], \"server_version\": [\"4030-894db91\"], \"image\": [\"chrome-trusty-18042300-b7223b463e3\"], \"gpu\": [\"none\"], \"cores\": [\"32\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-14.04\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Haswell_GCE\", \"x86-64-avx2\"], \"pool\": [\"luci.chromium.ci\"], \"caches\": [\"builder_4546ef179f50eb727f19fe6abd7705a7b8921ff8263e4e2e8e2644dd615ef1a7_v2\", \"git\", \"goma_v2\", \"vpython\"]}}, \"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1548825160898196",
"status": "COMPLETED",
"status_changed_ts": "1548836013604461",
"tags": [
"build_address:luci.chromium.ci/Linux CFI/12584",
"builder:Linux CFI",
"buildset:commit/git/e26756e70b44b084601b363b0544ce0fece78464",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/e26756e70b44b084601b363b0544ce0fece78464",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9088362940003873984",
"scheduler_job_id:chromium/Linux CFI",
"swarming_dimension:builder:Linux CFI",
"swarming_dimension:caches:builder_4546ef179f50eb727f19fe6abd7705a7b8921ff8263e4e2e8e2644dd615ef1a7_v2",
"swarming_dimension:cores:32",
"swarming_dimension:cpu:x86-64",
"swarming_dimension:os:Ubuntu-14.04",
"swarming_dimension:pool:luci.chromium.ci",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:build_address:luci.chromium.ci/Linux CFI/12584",
"swarming_tag:buildbucket_bucket:chromium/ci",
"swarming_tag:buildbucket_build_id:8922932877554989472",
"swarming_tag:buildbucket_hostname:cr-buildbucket.appspot.com",
"swarming_tag:buildbucket_template_canary:0",
"swarming_tag:buildbucket_template_revision:01134cf47e8a2d5d7cea5ec1232ca64ed2f16a5c",
"swarming_tag:builder:Linux CFI",
"swarming_tag:buildset:commit/git/e26756e70b44b084601b363b0544ce0fece78464",
"swarming_tag:buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/e26756e70b44b084601b363b0544ce0fece78464",
"swarming_tag:caches:builder_4546ef179f50eb727f19fe6abd7705a7b8921ff8263e4e2e8e2644dd615ef1a7_v2",
"swarming_tag:cores:32",
"swarming_tag:cpu:x86-64",
"swarming_tag:gitiles_ref:refs/heads/master",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8922932877554989472/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:os:Ubuntu-14.04",
"swarming_tag:pool:luci.chromium.ci",
"swarming_tag:priority:30",
"swarming_tag:recipe_name:chromium",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_tag:scheduler_invocation_id:9088362940003873984",
"swarming_tag:scheduler_job_id:chromium/Linux CFI",
"swarming_tag:service_account:chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"swarming_tag:swarming.pool.template:skip",
"swarming_tag:swarming.pool.version:4c16436c5a2d36c0d0298bf90c374ab67f50af8c",
"swarming_tag:user:None",
"swarming_tag:user_agent:luci-scheduler",
"swarming_tag:vpython:native-python-wrapper",
"swarming_task_id:42b5fd3097c08e10",
"user_agent:luci-scheduler"
],
"updated_ts": "1548836013605606",
"url": "https://ci.chromium.org/b/8922932877554989472",
"utcnow_ts": "1548836014162205"
}
}
[08:13:34.175] Invocation finished in 3h1m46.02808675s with status FAILED