[11:46:06.923] New invocation is queued and will start shortly
[11:46:08.268] Starting the invocation (attempt 1)
[11:46:08.331] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[11:46:08.331] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[11:46:08.331] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9019031452699152048",
"parameters_json": "{\"builder_name\":\"win32-official\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"13c1b057f5eeae560b21568a4427626642eb743f\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:win32-official",
"scheduler_invocation_id:9019031452699152048",
"scheduler_job_id:chromium/win32-official",
"user_agent:luci-scheduler",
"buildset:commit/git/13c1b057f5eeae560b21568a4427626642eb743f",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/13c1b057f5eeae560b21568a4427626642eb743f",
"gitiles_ref:refs/heads/master"
]
}
[11:46:08.952] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1614944768445933",
"id": "8853601390441355584",
"parameters_json": "{\"builder_name\": \"win32-official\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"13c1b057f5eeae560b21568a4427626642eb743f\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1614944768852955",
"tags": [
"build_address:luci.chromium.ci/win32-official/1645",
"builder:win32-official",
"buildset:commit/git/13c1b057f5eeae560b21568a4427626642eb743f",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/13c1b057f5eeae560b21568a4427626642eb743f",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9019031452699152048",
"scheduler_job_id:chromium/win32-official",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8853601390441355584/+/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": "1614944768853059",
"url": "https://ci.chromium.org/b/8853601390441355584",
"utcnow_ts": "1614944768944876"
}
}
[11:46:08.952] Task URL: https://ci.chromium.org/b/8853601390441355584
[11:46:08.952] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:2:0) after 1m0s
[11:46:23.621] Received PubSub notification, asking Buildbucket for the build status
[11:46:23.697] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:47:09.002] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:2:0)
[11:47:09.002] Timer tick, asking Buildbucket for the build status
[11:47:09.094] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:47:09.094] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:4:0) after 1m0s
[11:48:09.125] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:4:0)
[11:48:09.125] Timer tick, asking Buildbucket for the build status
[11:48:09.272] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:48:09.272] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:5:0) after 1m0s
[11:49:09.433] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:5:0)
[11:49:09.433] Timer tick, asking Buildbucket for the build status
[11:49:09.498] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:49:09.498] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:6:0) after 1m0s
[11:50:09.663] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:6:0)
[11:50:09.663] Timer tick, asking Buildbucket for the build status
[11:50:09.746] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:50:09.746] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:7:0) after 1m0s
[11:51:09.763] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:7:0)
[11:51:09.763] Timer tick, asking Buildbucket for the build status
[11:51:09.877] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:51:09.877] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:8:0) after 1m0s
[11:52:09.896] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:8:0)
[11:52:09.896] Timer tick, asking Buildbucket for the build status
[11:52:09.989] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:52:09.989] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:9:0) after 1m0s
[11:53:10.167] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:9:0)
[11:53:10.167] Timer tick, asking Buildbucket for the build status
[11:53:10.229] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:53:10.229] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:10:0) after 1m0s
[11:54:10.280] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:10:0)
[11:54:10.280] Timer tick, asking Buildbucket for the build status
[11:54:10.355] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:54:10.355] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:11:0) after 1m0s
[11:55:10.422] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:11:0)
[11:55:10.423] Timer tick, asking Buildbucket for the build status
[11:55:10.501] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:55:10.501] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:12:0) after 1m0s
[11:56:10.526] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:12:0)
[11:56:10.526] Timer tick, asking Buildbucket for the build status
[11:56:10.607] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:56:10.607] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:13:0) after 1m0s
[11:57:10.687] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:13:0)
[11:57:10.687] Timer tick, asking Buildbucket for the build status
[11:57:10.937] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:57:10.937] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:14:0) after 1m0s
[11:58:11.009] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:14:0)
[11:58:11.009] Timer tick, asking Buildbucket for the build status
[11:58:11.082] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:58:11.082] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:15:0) after 1m0s
[11:59:11.107] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:15:0)
[11:59:11.107] Timer tick, asking Buildbucket for the build status
[11:59:11.252] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:59:11.252] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:16:0) after 1m0s
[12:00:11.280] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:16:0)
[12:00:11.280] Timer tick, asking Buildbucket for the build status
[12:00:11.365] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:00:11.365] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:17:0) after 1m0s
[12:01:11.405] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:17:0)
[12:01:11.405] Timer tick, asking Buildbucket for the build status
[12:01:11.571] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:01:11.571] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:18:0) after 1m0s
[12:02:11.607] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:18:0)
[12:02:11.607] Timer tick, asking Buildbucket for the build status
[12:02:11.695] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:02:11.695] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:19:0) after 1m0s
[12:03:11.715] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:19:0)
[12:03:11.715] Timer tick, asking Buildbucket for the build status
[12:03:11.802] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:03:11.802] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:20:0) after 1m0s
[12:04:11.867] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:20:0)
[12:04:11.867] Timer tick, asking Buildbucket for the build status
[12:04:11.949] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:04:11.949] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:21:0) after 1m0s
[12:05:12.238] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:21:0)
[12:05:12.238] Timer tick, asking Buildbucket for the build status
[12:05:12.304] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:05:12.304] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:22:0) after 1m0s
[12:06:12.528] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:22:0)
[12:06:12.528] Timer tick, asking Buildbucket for the build status
[12:06:12.618] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:06:12.618] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:23:0) after 1m0s
[12:07:12.777] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:23:0)
[12:07:12.777] Timer tick, asking Buildbucket for the build status
[12:07:12.930] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:07:12.930] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:24:0) after 1m0s
[12:08:12.948] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:24:0)
[12:08:12.948] Timer tick, asking Buildbucket for the build status
[12:08:13.013] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:08:13.013] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:25:0) after 1m0s
[12:09:13.127] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:25:0)
[12:09:13.127] Timer tick, asking Buildbucket for the build status
[12:09:13.200] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:09:13.200] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:26:0) after 1m0s
[12:10:13.293] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:26:0)
[12:10:13.294] Timer tick, asking Buildbucket for the build status
[12:10:13.373] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:10:13.373] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:27:0) after 1m0s
[12:11:13.524] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:27:0)
[12:11:13.524] Timer tick, asking Buildbucket for the build status
[12:11:13.818] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:11:13.818] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:28:0) after 1m0s
[12:12:13.900] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:28:0)
[12:12:13.900] Timer tick, asking Buildbucket for the build status
[12:12:13.979] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:12:13.979] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:29:0) after 1m0s
[12:13:14.216] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:29:0)
[12:13:14.216] Timer tick, asking Buildbucket for the build status
[12:13:14.287] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:13:14.287] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:30:0) after 1m0s
[12:14:14.328] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:30:0)
[12:14:14.328] Timer tick, asking Buildbucket for the build status
[12:14:14.414] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:14:14.414] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:31:0) after 1m0s
[12:15:15.067] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:31:0)
[12:15:15.067] Timer tick, asking Buildbucket for the build status
[12:15:15.263] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:15:15.263] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:32:0) after 1m0s
[12:16:15.345] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:32:0)
[12:16:15.345] Timer tick, asking Buildbucket for the build status
[12:16:15.619] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:16:15.619] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:33:0) after 1m0s
[12:17:15.743] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:33:0)
[12:17:15.743] Timer tick, asking Buildbucket for the build status
[12:17:16.058] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:17:16.058] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:34:0) after 1m0s
[12:18:16.109] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:34:0)
[12:18:16.109] Timer tick, asking Buildbucket for the build status
[12:18:16.173] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:18:16.173] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:35:0) after 1m0s
[12:19:16.235] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:35:0)
[12:19:16.235] Timer tick, asking Buildbucket for the build status
[12:19:16.348] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:19:16.348] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:36:0) after 1m0s
[12:20:16.580] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:36:0)
[12:20:16.580] Timer tick, asking Buildbucket for the build status
[12:20:16.671] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:20:16.671] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:37:0) after 1m0s
[12:21:16.690] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:37:0)
[12:21:16.690] Timer tick, asking Buildbucket for the build status
[12:21:16.864] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:21:16.864] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:38:0) after 1m0s
[12:22:16.922] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:38:0)
[12:22:16.922] Timer tick, asking Buildbucket for the build status
[12:22:17.019] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:22:17.019] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:39:0) after 1m0s
[12:23:17.001] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:39:0)
[12:23:17.001] Timer tick, asking Buildbucket for the build status
[12:23:17.070] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:23:17.070] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:40:0) after 1m0s
[12:24:17.123] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:40:0)
[12:24:17.123] Timer tick, asking Buildbucket for the build status
[12:24:17.434] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:24:17.434] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:41:0) after 1m0s
[12:25:17.499] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:41:0)
[12:25:17.499] Timer tick, asking Buildbucket for the build status
[12:25:17.794] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:25:17.794] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:42:0) after 1m0s
[12:26:17.836] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:42:0)
[12:26:17.836] Timer tick, asking Buildbucket for the build status
[12:26:17.927] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:26:17.927] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:43:0) after 1m0s
[12:27:17.955] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:43:0)
[12:27:17.955] Timer tick, asking Buildbucket for the build status
[12:27:18.164] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:27:18.164] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:44:0) after 1m0s
[12:28:18.239] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:44:0)
[12:28:18.239] Timer tick, asking Buildbucket for the build status
[12:28:18.805] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:28:18.805] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:45:0) after 1m0s
[12:29:18.824] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:45:0)
[12:29:18.824] Timer tick, asking Buildbucket for the build status
[12:29:18.926] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:29:18.926] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:46:0) after 1m0s
[12:30:19.042] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:46:0)
[12:30:19.042] Timer tick, asking Buildbucket for the build status
[12:30:19.325] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:30:19.325] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:47:0) after 1m0s
[12:31:19.369] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:47:0)
[12:31:19.369] Timer tick, asking Buildbucket for the build status
[12:31:19.689] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:31:19.689] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:48:0) after 1m0s
[12:32:19.712] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:48:0)
[12:32:19.712] Timer tick, asking Buildbucket for the build status
[12:32:19.867] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:32:19.867] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:49:0) after 1m0s
[12:33:19.917] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:49:0)
[12:33:19.917] Timer tick, asking Buildbucket for the build status
[12:33:19.984] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:33:19.984] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:50:0) after 1m0s
[12:34:19.990] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:50:0)
[12:34:19.990] Timer tick, asking Buildbucket for the build status
[12:34:20.073] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:34:20.073] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:51:0) after 1m0s
[12:35:20.118] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:51:0)
[12:35:20.118] Timer tick, asking Buildbucket for the build status
[12:35:20.253] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:35:20.253] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:52:0) after 1m0s
[12:36:20.301] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:52:0)
[12:36:20.301] Timer tick, asking Buildbucket for the build status
[12:36:20.642] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:36:20.642] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:53:0) after 1m0s
[12:37:20.639] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:53:0)
[12:37:20.639] Timer tick, asking Buildbucket for the build status
[12:37:20.707] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:37:20.707] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:54:0) after 1m0s
[12:38:20.758] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:54:0)
[12:38:20.758] Timer tick, asking Buildbucket for the build status
[12:38:21.156] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:38:21.156] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:55:0) after 1m0s
[12:39:21.181] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:55:0)
[12:39:21.181] Timer tick, asking Buildbucket for the build status
[12:39:21.263] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:39:21.263] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:56:0) after 1m0s
[12:40:21.252] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:56:0)
[12:40:21.252] Timer tick, asking Buildbucket for the build status
[12:40:21.329] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:40:21.329] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:57:0) after 1m0s
[12:41:21.375] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:57:0)
[12:41:21.375] Timer tick, asking Buildbucket for the build status
[12:41:21.532] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:41:21.532] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:58:0) after 1m0s
[12:42:21.551] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:58:0)
[12:42:21.551] Timer tick, asking Buildbucket for the build status
[12:42:21.809] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:42:21.809] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:59:0) after 1m0s
[12:43:21.848] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:59:0)
[12:43:21.848] Timer tick, asking Buildbucket for the build status
[12:43:21.926] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:43:21.927] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:60:0) after 1m0s
[12:44:21.928] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:60:0)
[12:44:21.928] Timer tick, asking Buildbucket for the build status
[12:44:22.011] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:44:22.011] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:61:0) after 1m0s
[12:45:22.060] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:61:0)
[12:45:22.060] Timer tick, asking Buildbucket for the build status
[12:45:22.145] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:45:22.145] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:62:0) after 1m0s
[12:46:22.134] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:62:0)
[12:46:22.134] Timer tick, asking Buildbucket for the build status
[12:46:22.449] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:46:22.449] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:63:0) after 1m0s
[12:47:22.441] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:63:0)
[12:47:22.441] Timer tick, asking Buildbucket for the build status
[12:47:22.506] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:47:22.506] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:64:0) after 1m0s
[12:48:22.493] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:64:0)
[12:48:22.493] Timer tick, asking Buildbucket for the build status
[12:48:22.556] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:48:22.556] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:65:0) after 1m0s
[12:49:22.579] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:65:0)
[12:49:22.579] Timer tick, asking Buildbucket for the build status
[12:49:22.669] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:49:22.669] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:66:0) after 1m0s
[12:50:22.687] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:66:0)
[12:50:22.687] Timer tick, asking Buildbucket for the build status
[12:50:22.747] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:50:22.747] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:67:0) after 1m0s
[12:51:22.770] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:67:0)
[12:51:22.770] Timer tick, asking Buildbucket for the build status
[12:51:22.934] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:51:22.934] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:68:0) after 1m0s
[12:52:23.432] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:68:0)
[12:52:23.432] Timer tick, asking Buildbucket for the build status
[12:52:23.508] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:52:23.508] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:69:0) after 1m0s
[12:53:23.597] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:69:0)
[12:53:23.597] Timer tick, asking Buildbucket for the build status
[12:53:23.792] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:53:23.793] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:70:0) after 1m0s
[12:54:23.824] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:70:0)
[12:54:23.824] Timer tick, asking Buildbucket for the build status
[12:54:23.965] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:54:23.965] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:71:0) after 1m0s
[12:55:23.945] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:71:0)
[12:55:23.945] Timer tick, asking Buildbucket for the build status
[12:55:24.015] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:55:24.015] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:72:0) after 1m0s
[12:56:24.047] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:72:0)
[12:56:24.047] Timer tick, asking Buildbucket for the build status
[12:56:24.217] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:56:24.218] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:73:0) after 1m0s
[12:57:24.251] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:73:0)
[12:57:24.251] Timer tick, asking Buildbucket for the build status
[12:57:24.337] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:57:24.337] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:74:0) after 1m0s
[12:58:24.713] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:74:0)
[12:58:24.713] Timer tick, asking Buildbucket for the build status
[12:58:24.783] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:58:24.783] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:75:0) after 1m0s
[12:59:25.047] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:75:0)
[12:59:25.047] Timer tick, asking Buildbucket for the build status
[12:59:25.122] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:59:25.122] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:76:0) after 1m0s
[13:00:25.157] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:76:0)
[13:00:25.157] Timer tick, asking Buildbucket for the build status
[13:00:25.218] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:00:25.218] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:77:0) after 1m0s
[13:01:25.382] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:77:0)
[13:01:25.382] Timer tick, asking Buildbucket for the build status
[13:01:25.509] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:01:25.509] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:78:0) after 1m0s
[13:02:25.681] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:78:0)
[13:02:25.681] Timer tick, asking Buildbucket for the build status
[13:02:26.131] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:02:26.131] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:79:0) after 1m0s
[13:03:26.258] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:79:0)
[13:03:26.258] Timer tick, asking Buildbucket for the build status
[13:03:26.429] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:03:26.429] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:80:0) after 1m0s
[13:04:26.515] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:80:0)
[13:04:26.515] Timer tick, asking Buildbucket for the build status
[13:04:26.582] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:04:26.582] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:81:0) after 1m0s
[13:05:26.719] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:81:0)
[13:05:26.719] Timer tick, asking Buildbucket for the build status
[13:05:27.017] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:05:27.017] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:82:0) after 1m0s
[13:06:27.087] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:82:0)
[13:06:27.087] Timer tick, asking Buildbucket for the build status
[13:06:27.210] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:06:27.210] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:83:0) after 1m0s
[13:07:27.251] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:83:0)
[13:07:27.251] Timer tick, asking Buildbucket for the build status
[13:07:27.327] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:07:27.327] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:84:0) after 1m0s
[13:08:27.439] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:84:0)
[13:08:27.439] Timer tick, asking Buildbucket for the build status
[13:08:27.615] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:08:27.615] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:85:0) after 1m0s
[13:09:27.671] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:85:0)
[13:09:27.671] Timer tick, asking Buildbucket for the build status
[13:09:27.768] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:09:27.769] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:86:0) after 1m0s
[13:10:27.808] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:86:0)
[13:10:27.808] Timer tick, asking Buildbucket for the build status
[13:10:27.884] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:10:27.884] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:87:0) after 1m0s
[13:11:27.910] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:87:0)
[13:11:27.910] Timer tick, asking Buildbucket for the build status
[13:11:28.018] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:11:28.018] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:88:0) after 1m0s
[13:12:28.038] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:88:0)
[13:12:28.038] Timer tick, asking Buildbucket for the build status
[13:12:28.113] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:12:28.113] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:89:0) after 1m0s
[13:13:28.401] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:89:0)
[13:13:28.401] Timer tick, asking Buildbucket for the build status
[13:13:28.751] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:13:28.751] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:90:0) after 1m0s
[13:14:28.755] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:90:0)
[13:14:28.755] Timer tick, asking Buildbucket for the build status
[13:14:28.870] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:14:28.870] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:91:0) after 1m0s
[13:15:28.954] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:91:0)
[13:15:28.954] Timer tick, asking Buildbucket for the build status
[13:15:29.148] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:15:29.148] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:92:0) after 1m0s
[13:16:29.140] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:92:0)
[13:16:29.141] Timer tick, asking Buildbucket for the build status
[13:16:29.428] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:16:29.428] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:93:0) after 1m0s
[13:17:29.574] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:93:0)
[13:17:29.574] Timer tick, asking Buildbucket for the build status
[13:17:29.813] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:17:29.813] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:94:0) after 1m0s
[13:18:29.915] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:94:0)
[13:18:29.915] Timer tick, asking Buildbucket for the build status
[13:18:29.987] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:18:29.987] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:95:0) after 1m0s
[13:19:29.971] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:95:0)
[13:19:29.971] Timer tick, asking Buildbucket for the build status
[13:19:30.057] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:19:30.058] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:96:0) after 1m0s
[13:20:30.052] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:96:0)
[13:20:30.052] Timer tick, asking Buildbucket for the build status
[13:20:30.121] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:20:30.121] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:97:0) after 1m0s
[13:21:30.238] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:97:0)
[13:21:30.238] Timer tick, asking Buildbucket for the build status
[13:21:30.365] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:21:30.365] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:98:0) after 1m0s
[13:22:30.401] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:98:0)
[13:22:30.401] Timer tick, asking Buildbucket for the build status
[13:22:30.475] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:22:30.475] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:99:0) after 1m0s
[13:23:30.519] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:99:0)
[13:23:30.519] Timer tick, asking Buildbucket for the build status
[13:23:30.824] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:23:30.824] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:100:0) after 1m0s
[13:24:30.917] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:100:0)
[13:24:30.917] Timer tick, asking Buildbucket for the build status
[13:24:30.987] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:24:30.987] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:101:0) after 1m0s
[13:25:31.183] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:101:0)
[13:25:31.183] Timer tick, asking Buildbucket for the build status
[13:25:31.266] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:25:31.266] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:102:0) after 1m0s
[13:26:31.588] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:102:0)
[13:26:31.588] Timer tick, asking Buildbucket for the build status
[13:26:31.691] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:26:31.691] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:103:0) after 1m0s
[13:27:31.832] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:103:0)
[13:27:31.832] Timer tick, asking Buildbucket for the build status
[13:27:31.905] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:27:31.905] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:104:0) after 1m0s
[13:28:32.112] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:104:0)
[13:28:32.112] Timer tick, asking Buildbucket for the build status
[13:28:32.214] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:28:32.214] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:105:0) after 1m0s
[13:29:32.329] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:105:0)
[13:29:32.329] Timer tick, asking Buildbucket for the build status
[13:29:32.454] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:29:32.454] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:106:0) after 1m0s
[13:30:32.522] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:106:0)
[13:30:32.522] Timer tick, asking Buildbucket for the build status
[13:30:32.717] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:30:32.717] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:107:0) after 1m0s
[13:31:32.770] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:107:0)
[13:31:32.770] Timer tick, asking Buildbucket for the build status
[13:31:32.856] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:31:32.856] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:108:0) after 1m0s
[13:32:33.040] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:108:0)
[13:32:33.040] Timer tick, asking Buildbucket for the build status
[13:32:33.232] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:32:33.232] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:109:0) after 1m0s
[13:33:33.448] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:109:0)
[13:33:33.448] Timer tick, asking Buildbucket for the build status
[13:33:33.516] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:33:33.516] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:110:0) after 1m0s
[13:34:33.617] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:110:0)
[13:34:33.617] Timer tick, asking Buildbucket for the build status
[13:34:33.805] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:34:33.805] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:111:0) after 1m0s
[13:35:33.825] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:111:0)
[13:35:33.825] Timer tick, asking Buildbucket for the build status
[13:35:34.007] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:35:34.007] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:112:0) after 1m0s
[13:36:34.030] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:112:0)
[13:36:34.030] Timer tick, asking Buildbucket for the build status
[13:36:34.166] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:36:34.166] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:113:0) after 1m0s
[13:37:34.188] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:113:0)
[13:37:34.188] Timer tick, asking Buildbucket for the build status
[13:37:34.252] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:37:34.252] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:114:0) after 1m0s
[13:38:34.325] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:114:0)
[13:38:34.325] Timer tick, asking Buildbucket for the build status
[13:38:34.399] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:38:34.399] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:115:0) after 1m0s
[13:39:34.429] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:115:0)
[13:39:34.430] Timer tick, asking Buildbucket for the build status
[13:39:34.504] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:39:34.504] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:116:0) after 1m0s
[13:40:34.531] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:116:0)
[13:40:34.531] Timer tick, asking Buildbucket for the build status
[13:40:34.633] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:40:34.633] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:117:0) after 1m0s
[13:41:34.662] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:117:0)
[13:41:34.662] Timer tick, asking Buildbucket for the build status
[13:41:34.748] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:41:34.748] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:118:0) after 1m0s
[13:42:34.769] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:118:0)
[13:42:34.769] Timer tick, asking Buildbucket for the build status
[13:42:34.968] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:42:34.968] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:119:0) after 1m0s
[13:43:35.058] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:119:0)
[13:43:35.058] Timer tick, asking Buildbucket for the build status
[13:43:35.136] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:43:35.136] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:120:0) after 1m0s
[13:44:35.165] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:120:0)
[13:44:35.165] Timer tick, asking Buildbucket for the build status
[13:44:35.246] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:44:35.246] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:121:0) after 1m0s
[13:45:35.303] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:121:0)
[13:45:35.303] Timer tick, asking Buildbucket for the build status
[13:45:35.532] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:45:35.532] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:122:0) after 1m0s
[13:46:35.578] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:122:0)
[13:46:35.578] Timer tick, asking Buildbucket for the build status
[13:46:35.724] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:46:35.724] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:123:0) after 1m0s
[13:47:35.762] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:123:0)
[13:47:35.762] Timer tick, asking Buildbucket for the build status
[13:47:35.842] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:47:35.842] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:124:0) after 1m0s
[13:48:35.958] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:124:0)
[13:48:35.958] Timer tick, asking Buildbucket for the build status
[13:48:36.033] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:48:36.033] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:125:0) after 1m0s
[13:49:36.089] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:125:0)
[13:49:36.090] Timer tick, asking Buildbucket for the build status
[13:49:36.192] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:49:36.192] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:126:0) after 1m0s
[13:50:36.216] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:126:0)
[13:50:36.216] Timer tick, asking Buildbucket for the build status
[13:50:36.380] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:50:36.380] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:127:0) after 1m0s
[13:51:36.482] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:127:0)
[13:51:36.482] Timer tick, asking Buildbucket for the build status
[13:51:36.592] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:51:36.592] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:128:0) after 1m0s
[13:52:36.645] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:128:0)
[13:52:36.645] Timer tick, asking Buildbucket for the build status
[13:52:36.707] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:52:36.707] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:129:0) after 1m0s
[13:53:36.830] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:129:0)
[13:53:36.830] Timer tick, asking Buildbucket for the build status
[13:53:36.900] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:53:36.900] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:130:0) after 1m0s
[13:54:36.920] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:130:0)
[13:54:36.920] Timer tick, asking Buildbucket for the build status
[13:54:37.058] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:54:37.058] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:131:0) after 1m0s
[13:55:37.155] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:131:0)
[13:55:37.155] Timer tick, asking Buildbucket for the build status
[13:55:37.231] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:55:37.231] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:132:0) after 1m0s
[13:56:37.215] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:132:0)
[13:56:37.215] Timer tick, asking Buildbucket for the build status
[13:56:37.298] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:56:37.299] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:133:0) after 1m0s
[13:57:37.358] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:133:0)
[13:57:37.358] Timer tick, asking Buildbucket for the build status
[13:57:37.443] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:57:37.443] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:134:0) after 1m0s
[13:58:37.489] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:134:0)
[13:58:37.489] Timer tick, asking Buildbucket for the build status
[13:58:37.703] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:58:37.703] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:135:0) after 1m0s
[13:59:37.751] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:135:0)
[13:59:37.751] Timer tick, asking Buildbucket for the build status
[13:59:37.935] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:59:37.935] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:136:0) after 1m0s
[14:00:37.986] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:136:0)
[14:00:37.986] Timer tick, asking Buildbucket for the build status
[14:00:38.062] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:00:38.062] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:137:0) after 1m0s
[14:01:38.205] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:137:0)
[14:01:38.205] Timer tick, asking Buildbucket for the build status
[14:01:38.288] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:01:38.288] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:138:0) after 1m0s
[14:02:38.362] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:138:0)
[14:02:38.362] Timer tick, asking Buildbucket for the build status
[14:02:38.810] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:02:38.810] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:139:0) after 1m0s
[14:03:38.863] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:139:0)
[14:03:38.863] Timer tick, asking Buildbucket for the build status
[14:03:38.930] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:03:38.930] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:140:0) after 1m0s
[14:04:38.970] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:140:0)
[14:04:38.970] Timer tick, asking Buildbucket for the build status
[14:04:39.252] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:04:39.252] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:141:0) after 1m0s
[14:05:39.305] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:141:0)
[14:05:39.305] Timer tick, asking Buildbucket for the build status
[14:05:39.432] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:05:39.432] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:142:0) after 1m0s
[14:06:39.529] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:142:0)
[14:06:39.529] Timer tick, asking Buildbucket for the build status
[14:06:39.609] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:06:39.609] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:143:0) after 1m0s
[14:07:39.658] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:143:0)
[14:07:39.658] Timer tick, asking Buildbucket for the build status
[14:07:39.825] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:07:39.825] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:144:0) after 1m0s
[14:08:39.854] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:144:0)
[14:08:39.854] Timer tick, asking Buildbucket for the build status
[14:08:39.970] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:08:39.970] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:145:0) after 1m0s
[14:09:40.293] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:145:0)
[14:09:40.293] Timer tick, asking Buildbucket for the build status
[14:09:40.359] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:09:40.359] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:146:0) after 1m0s
[14:10:40.485] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:146:0)
[14:10:40.485] Timer tick, asking Buildbucket for the build status
[14:10:40.555] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:10:40.555] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:147:0) after 1m0s
[14:11:40.917] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:147:0)
[14:11:40.917] Timer tick, asking Buildbucket for the build status
[14:11:41.246] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:11:41.246] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:148:0) after 1m0s
[14:12:42.089] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:148:0)
[14:12:42.089] Timer tick, asking Buildbucket for the build status
[14:12:42.163] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:12:42.163] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:149:0) after 1m0s
[14:13:42.370] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:149:0)
[14:13:42.370] Timer tick, asking Buildbucket for the build status
[14:13:42.447] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:13:42.447] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:150:0) after 1m0s
[14:14:42.483] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:150:0)
[14:14:42.483] Timer tick, asking Buildbucket for the build status
[14:14:42.652] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:14:42.652] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:151:0) after 1m0s
[14:15:42.729] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:151:0)
[14:15:42.729] Timer tick, asking Buildbucket for the build status
[14:15:42.828] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:15:42.828] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:152:0) after 1m0s
[14:16:42.974] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:152:0)
[14:16:42.974] Timer tick, asking Buildbucket for the build status
[14:16:43.066] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:16:43.066] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:153:0) after 1m0s
[14:17:43.107] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:153:0)
[14:17:43.107] Timer tick, asking Buildbucket for the build status
[14:17:43.168] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:17:43.168] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:154:0) after 1m0s
[14:18:43.224] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:154:0)
[14:18:43.224] Timer tick, asking Buildbucket for the build status
[14:18:44.108] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:18:44.109] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:155:0) after 1m0s
[14:19:44.152] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:155:0)
[14:19:44.152] Timer tick, asking Buildbucket for the build status
[14:19:44.242] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:19:44.242] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:156:0) after 1m0s
[14:20:44.282] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:156:0)
[14:20:44.282] Timer tick, asking Buildbucket for the build status
[14:20:44.563] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:20:44.563] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:157:0) after 1m0s
[14:21:44.657] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:157:0)
[14:21:44.657] Timer tick, asking Buildbucket for the build status
[14:21:44.747] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:21:44.747] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:158:0) after 1m0s
[14:22:44.762] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:158:0)
[14:22:44.762] Timer tick, asking Buildbucket for the build status
[14:22:44.830] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:22:44.830] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:159:0) after 1m0s
[14:23:44.829] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:159:0)
[14:23:44.829] Timer tick, asking Buildbucket for the build status
[14:23:44.896] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:23:44.896] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:160:0) after 1m0s
[14:24:44.918] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:160:0)
[14:24:44.918] Timer tick, asking Buildbucket for the build status
[14:24:45.014] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:24:45.014] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:161:0) after 1m0s
[14:25:45.057] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:161:0)
[14:25:45.057] Timer tick, asking Buildbucket for the build status
[14:25:45.121] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:25:45.121] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:162:0) after 1m0s
[14:26:45.171] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:162:0)
[14:26:45.171] Timer tick, asking Buildbucket for the build status
[14:26:45.562] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:26:45.562] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:163:0) after 1m0s
[14:27:45.574] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:163:0)
[14:27:45.574] Timer tick, asking Buildbucket for the build status
[14:27:45.712] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:27:45.712] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:164:0) after 1m0s
[14:28:45.735] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:164:0)
[14:28:45.735] Timer tick, asking Buildbucket for the build status
[14:28:45.919] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:28:45.919] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:165:0) after 1m0s
[14:29:45.938] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:165:0)
[14:29:45.938] Timer tick, asking Buildbucket for the build status
[14:29:46.021] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:29:46.021] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:166:0) after 1m0s
[14:30:46.043] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:166:0)
[14:30:46.043] Timer tick, asking Buildbucket for the build status
[14:30:46.118] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:30:46.118] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:167:0) after 1m0s
[14:31:46.144] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:167:0)
[14:31:46.144] Timer tick, asking Buildbucket for the build status
[14:31:46.233] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:31:46.233] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:168:0) after 1m0s
[14:32:46.246] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:168:0)
[14:32:46.246] Timer tick, asking Buildbucket for the build status
[14:32:46.351] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:32:46.351] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:169:0) after 1m0s
[14:33:46.488] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:169:0)
[14:33:46.488] Timer tick, asking Buildbucket for the build status
[14:33:46.565] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:33:46.565] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:170:0) after 1m0s
[14:34:46.602] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:170:0)
[14:34:46.602] Timer tick, asking Buildbucket for the build status
[14:34:46.664] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:34:46.664] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:171:0) after 1m0s
[14:35:46.731] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:171:0)
[14:35:46.731] Timer tick, asking Buildbucket for the build status
[14:35:46.797] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:35:46.797] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:172:0) after 1m0s
[14:36:46.994] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:172:0)
[14:36:46.994] Timer tick, asking Buildbucket for the build status
[14:36:47.077] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:36:47.077] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:173:0) after 1m0s
[14:37:47.153] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:173:0)
[14:37:47.153] Timer tick, asking Buildbucket for the build status
[14:37:47.999] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:37:47.999] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:174:0) after 1m0s
[14:38:48.016] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:174:0)
[14:38:48.016] Timer tick, asking Buildbucket for the build status
[14:38:48.165] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:38:48.165] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:175:0) after 1m0s
[14:39:48.168] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:175:0)
[14:39:48.169] Timer tick, asking Buildbucket for the build status
[14:39:48.324] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:39:48.324] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:176:0) after 1m0s
[14:40:48.334] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:176:0)
[14:40:48.334] Timer tick, asking Buildbucket for the build status
[14:40:48.403] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:40:48.403] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:177:0) after 1m0s
[14:41:48.492] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:177:0)
[14:41:48.492] Timer tick, asking Buildbucket for the build status
[14:41:48.582] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:41:48.582] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:178:0) after 1m0s
[14:42:48.634] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:178:0)
[14:42:48.634] Timer tick, asking Buildbucket for the build status
[14:42:48.708] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:42:48.708] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:179:0) after 1m0s
[14:43:48.751] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:179:0)
[14:43:48.751] Timer tick, asking Buildbucket for the build status
[14:43:48.910] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:43:48.910] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:180:0) after 1m0s
[14:44:48.973] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:180:0)
[14:44:48.973] Timer tick, asking Buildbucket for the build status
[14:44:49.042] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:44:49.042] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:181:0) after 1m0s
[14:45:49.423] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:181:0)
[14:45:49.423] Timer tick, asking Buildbucket for the build status
[14:45:49.516] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:45:49.516] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:182:0) after 1m0s
[14:46:49.585] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:182:0)
[14:46:49.585] Timer tick, asking Buildbucket for the build status
[14:46:49.670] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:46:49.670] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:183:0) after 1m0s
[14:47:49.743] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:183:0)
[14:47:49.743] Timer tick, asking Buildbucket for the build status
[14:47:49.804] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:47:49.804] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:184:0) after 1m0s
[14:48:49.833] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:184:0)
[14:48:49.833] Timer tick, asking Buildbucket for the build status
[14:48:49.949] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:48:49.949] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:185:0) after 1m0s
[14:49:50.028] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:185:0)
[14:49:50.028] Timer tick, asking Buildbucket for the build status
[14:49:50.093] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:49:50.094] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:186:0) after 1m0s
[14:50:50.125] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:186:0)
[14:50:50.125] Timer tick, asking Buildbucket for the build status
[14:50:50.185] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:50:50.185] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:187:0) after 1m0s
[14:51:50.191] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:187:0)
[14:51:50.191] Timer tick, asking Buildbucket for the build status
[14:51:50.279] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:51:50.279] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:188:0) after 1m0s
[14:52:50.351] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:188:0)
[14:52:50.351] Timer tick, asking Buildbucket for the build status
[14:52:50.421] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:52:50.421] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:189:0) after 1m0s
[14:53:50.455] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:189:0)
[14:53:50.455] Timer tick, asking Buildbucket for the build status
[14:53:50.521] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:53:50.521] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:190:0) after 1m0s
[14:54:50.725] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:190:0)
[14:54:50.725] Timer tick, asking Buildbucket for the build status
[14:54:50.786] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:54:50.786] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:191:0) after 1m0s
[14:55:50.930] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:191:0)
[14:55:50.930] Timer tick, asking Buildbucket for the build status
[14:55:50.989] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:55:50.989] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:192:0) after 1m0s
[14:56:51.155] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:192:0)
[14:56:51.155] Timer tick, asking Buildbucket for the build status
[14:56:51.234] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:56:51.234] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:193:0) after 1m0s
[14:57:51.395] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:193:0)
[14:57:51.395] Timer tick, asking Buildbucket for the build status
[14:57:51.467] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:57:51.467] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:194:0) after 1m0s
[14:58:51.703] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:194:0)
[14:58:51.703] Timer tick, asking Buildbucket for the build status
[14:58:51.802] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:58:51.802] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:195:0) after 1m0s
[14:59:51.825] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:195:0)
[14:59:51.825] Timer tick, asking Buildbucket for the build status
[14:59:51.894] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:59:51.894] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:196:0) after 1m0s
[15:00:51.927] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:196:0)
[15:00:51.927] Timer tick, asking Buildbucket for the build status
[15:00:52.063] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:00:52.063] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:197:0) after 1m0s
[15:01:52.129] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:197:0)
[15:01:52.129] Timer tick, asking Buildbucket for the build status
[15:01:52.240] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:01:52.240] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:198:0) after 1m0s
[15:02:52.289] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:198:0)
[15:02:52.289] Timer tick, asking Buildbucket for the build status
[15:02:52.363] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:02:52.363] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:199:0) after 1m0s
[15:03:52.385] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:199:0)
[15:03:52.385] Timer tick, asking Buildbucket for the build status
[15:03:52.454] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:03:52.454] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:200:0) after 1m0s
[15:04:52.465] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:200:0)
[15:04:52.465] Timer tick, asking Buildbucket for the build status
[15:04:52.645] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:04:52.645] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:201:0) after 1m0s
[15:05:52.698] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:201:0)
[15:05:52.698] Timer tick, asking Buildbucket for the build status
[15:05:52.771] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:05:52.771] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:202:0) after 1m0s
[15:06:52.970] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:202:0)
[15:06:52.970] Timer tick, asking Buildbucket for the build status
[15:06:53.052] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:06:53.052] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:203:0) after 1m0s
[15:07:53.129] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:203:0)
[15:07:53.129] Timer tick, asking Buildbucket for the build status
[15:07:53.242] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:07:53.242] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:204:0) after 1m0s
[15:08:53.246] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:204:0)
[15:08:53.246] Timer tick, asking Buildbucket for the build status
[15:08:53.333] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:08:53.333] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:205:0) after 1m0s
[15:09:53.430] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:205:0)
[15:09:53.430] Timer tick, asking Buildbucket for the build status
[15:09:53.856] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:09:53.856] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:206:0) after 1m0s
[15:10:53.870] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:206:0)
[15:10:53.870] Timer tick, asking Buildbucket for the build status
[15:10:53.953] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:10:53.953] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:207:0) after 1m0s
[15:11:53.976] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:207:0)
[15:11:53.976] Timer tick, asking Buildbucket for the build status
[15:11:54.212] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:11:54.212] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:208:0) after 1m0s
[15:12:54.326] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:208:0)
[15:12:54.326] Timer tick, asking Buildbucket for the build status
[15:12:54.395] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:12:54.395] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:209:0) after 1m0s
[15:13:54.424] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:209:0)
[15:13:54.424] Timer tick, asking Buildbucket for the build status
[15:13:54.495] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:13:54.496] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:210:0) after 1m0s
[15:14:54.529] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:210:0)
[15:14:54.529] Timer tick, asking Buildbucket for the build status
[15:14:54.922] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:14:54.922] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:211:0) after 1m0s
[15:15:54.959] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:211:0)
[15:15:54.959] Timer tick, asking Buildbucket for the build status
[15:15:55.031] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:15:55.031] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:212:0) after 1m0s
[15:16:55.088] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:212:0)
[15:16:55.088] Timer tick, asking Buildbucket for the build status
[15:16:55.196] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:16:55.196] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:213:0) after 1m0s
[15:17:59.747] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:213:0)
[15:17:59.747] Timer tick, asking Buildbucket for the build status
[15:17:59.816] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:17:59.816] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:214:0) after 1m0s
[15:18:59.926] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:214:0)
[15:18:59.926] Timer tick, asking Buildbucket for the build status
[15:19:00.073] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:19:00.073] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:215:0) after 1m0s
[15:20:00.132] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:215:0)
[15:20:00.132] Timer tick, asking Buildbucket for the build status
[15:20:00.209] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:20:00.209] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:216:0) after 1m0s
[15:21:00.210] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:216:0)
[15:21:00.210] Timer tick, asking Buildbucket for the build status
[15:21:00.365] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:21:00.365] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:217:0) after 1m0s
[15:22:00.701] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:217:0)
[15:22:00.701] Timer tick, asking Buildbucket for the build status
[15:22:00.785] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:22:00.785] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:218:0) after 1m0s
[15:23:00.916] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:218:0)
[15:23:00.916] Timer tick, asking Buildbucket for the build status
[15:23:00.983] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:23:00.983] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:219:0) after 1m0s
[15:24:01.163] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:219:0)
[15:24:01.163] Timer tick, asking Buildbucket for the build status
[15:24:01.223] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:24:01.223] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:220:0) after 1m0s
[15:25:01.414] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:220:0)
[15:25:01.414] Timer tick, asking Buildbucket for the build status
[15:25:01.546] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:25:01.546] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:221:0) after 1m0s
[15:26:01.570] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:221:0)
[15:26:01.570] Timer tick, asking Buildbucket for the build status
[15:26:01.654] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:26:01.654] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:222:0) after 1m0s
[15:27:01.690] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:222:0)
[15:27:01.690] Timer tick, asking Buildbucket for the build status
[15:27:01.854] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:27:01.855] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:223:0) after 1m0s
[15:28:02.395] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:223:0)
[15:28:02.395] Timer tick, asking Buildbucket for the build status
[15:28:02.471] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:28:02.471] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:224:0) after 1m0s
[15:29:02.571] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:224:0)
[15:29:02.571] Timer tick, asking Buildbucket for the build status
[15:29:02.635] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:29:02.635] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:225:0) after 1m0s
[15:30:02.689] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:225:0)
[15:30:02.689] Timer tick, asking Buildbucket for the build status
[15:30:02.831] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:30:02.831] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:226:0) after 1m0s
[15:31:02.867] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:226:0)
[15:31:02.867] Timer tick, asking Buildbucket for the build status
[15:31:04.403] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:31:04.403] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:227:0) after 1m0s
[15:32:04.459] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:227:0)
[15:32:04.459] Timer tick, asking Buildbucket for the build status
[15:32:04.556] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:32:04.556] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:228:0) after 1m0s
[15:33:05.697] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:228:0)
[15:33:05.697] Timer tick, asking Buildbucket for the build status
[15:33:05.761] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:33:05.761] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:229:0) after 1m0s
[15:34:06.024] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:229:0)
[15:34:06.024] Timer tick, asking Buildbucket for the build status
[15:34:06.094] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:34:06.094] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:230:0) after 1m0s
[15:35:06.142] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:230:0)
[15:35:06.142] Timer tick, asking Buildbucket for the build status
[15:35:06.301] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:35:06.301] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:231:0) after 1m0s
[15:36:06.307] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:231:0)
[15:36:06.307] Timer tick, asking Buildbucket for the build status
[15:36:06.368] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:36:06.368] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:232:0) after 1m0s
[15:37:06.440] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:232:0)
[15:37:06.440] Timer tick, asking Buildbucket for the build status
[15:37:06.525] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:37:06.525] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:233:0) after 1m0s
[15:38:06.565] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:233:0)
[15:38:06.565] Timer tick, asking Buildbucket for the build status
[15:38:06.653] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:38:06.653] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:234:0) after 1m0s
[15:39:06.981] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:234:0)
[15:39:06.981] Timer tick, asking Buildbucket for the build status
[15:39:07.053] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:39:07.053] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:235:0) after 1m0s
[15:40:07.128] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:235:0)
[15:40:07.128] Timer tick, asking Buildbucket for the build status
[15:40:07.430] Build 8853601390441355584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:40:07.431] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9019031452699152048:236:0) after 1m0s
[15:40:07.801] Received PubSub notification, asking Buildbucket for the build status
[15:40:07.878] Build 8853601390441355584: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[15:40:07.878] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1614958806815415",
"created_by": "project:chromium",
"created_ts": "1614944768445933",
"id": "8853601390441355584",
"parameters_json": "{\"builder_name\": \"win32-official\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"13c1b057f5eeae560b21568a4427626642eb743f\"}}",
"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\": \"13c1b057f5eeae560b21568a4427626642eb743f\", \"project\": \"chromium/src\"}], \"$recipe_engine/path\": {\"cache_dir\": \"C:\\\\b\\\\s\\\\w\\\\ir\\\\cache\", \"temp_dir\": \"C:\\\\b\\\\s\\\\w\\\\ir\\\\tmp\\\\rt\"}, \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"bot_id\": \"win-dbg-1-1g29\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium\", \"buildername\": \"win32-official\", \"buildnumber\": 1645, \"got_angle_revision\": \"97127961f9f0f0e25cab891c20e7059c5958b694\", \"got_dawn_revision\": \"80915849ce7d5f4c0fe834924ed420ed0002b210\", \"got_nacl_revision\": \"abf3277f295c6c87f0b103f291ed5e3e73933b76\", \"got_revision\": \"13c1b057f5eeae560b21568a4427626642eb743f\", \"got_revision_cp\": \"refs/heads/master@{#860193}\", \"got_swarming_client_revision\": \"a32a1607f6093d338f756c7e7c7b4333b0c50c9c\", \"got_swiftshader_revision\": \"6846389f25cad4233a4bd04fd3fc6c60ae30ff35\", \"got_v8_revision\": \"3ada4ab958536c310f49288abe197d79f1bfec9a\", \"got_v8_revision_cp\": \"refs/heads/9.1.51@{#1}\", \"got_webrtc_revision\": \"3208bf102b75e8ec1eaa6640dfa3b545310b1e02\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#33382}\", \"is_cached\": true, \"mirrored_builders\": [\"tryserver.chromium:win32-official\"], \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"13c1b057f5eeae560b21568a4427626642eb743f\"}, \"swarming\": {\"bot_dimensions\": {\"builder\": [\"win-archive-dbg\", \"win-archive-rel\", \"win-official\", \"win32-archive-dbg\", \"win32-archive-rel\", \"win32-official\"], \"caches\": [\"builder_f6b49936a2965b3cdad8f63ce13313d0c4b82119a9acfffbfe199e91c26d0c88_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"32\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"win-dbg-1-1g29\"], \"image\": [\"chrome-win10-1703-20111600-a937a23cefb\"], \"integrity\": [\"high\"], \"locale\": [\"en_US.cp1252\"], \"machine_type\": [\"e2-standard-32\"], \"os\": [\"Windows\", \"Windows-10\", \"Windows-10-15063\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.13\"], \"server_version\": [\"5725-1a0d85e\"], \"ssd\": [\"0\"], \"windows_client_version\": [\"10\"], \"zone\": [\"us\", \"us-west\", \"us-west1\", \"us-west1-b\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1614944782643022",
"status": "COMPLETED",
"status_changed_ts": "1614958807344279",
"tags": [
"build_address:luci.chromium.ci/win32-official/1645",
"builder:win32-official",
"buildset:commit/git/13c1b057f5eeae560b21568a4427626642eb743f",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/13c1b057f5eeae560b21568a4427626642eb743f",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9019031452699152048",
"scheduler_job_id:chromium/win32-official",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8853601390441355584/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:os:Windows",
"swarming_tag:recipe_name:chromium",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:521b071c5c195910",
"user_agent:luci-scheduler"
],
"updated_ts": "1614958807350282",
"url": "https://ci.chromium.org/b/8853601390441355584",
"utcnow_ts": "1614958807872608"
}
}
[15:40:07.878] Invocation finished in 3h54m0.970753861s with status SUCCEEDED