[13:31:31.191] New invocation is queued and will start shortly
[13:31:32.648] Starting the invocation (attempt 1)
[13:31:32.691] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[13:31:32.691] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[13:31:32.691] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9026544369437236224",
"parameters_json": "{\"builder_name\":\"win-official\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"bc1447c707885cd7adcdd7a7f563d06005cde399\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:win-official",
"scheduler_invocation_id:9026544369437236224",
"scheduler_job_id:chromium/win-official",
"user_agent:luci-scheduler",
"buildset:commit/git/bc1447c707885cd7adcdd7a7f563d06005cde399",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/bc1447c707885cd7adcdd7a7f563d06005cde399",
"gitiles_ref:refs/heads/master"
]
}
[13:31:33.283] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1607779892829655",
"id": "8861114307055191952",
"parameters_json": "{\"builder_name\": \"win-official\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"bc1447c707885cd7adcdd7a7f563d06005cde399\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1607779893157080",
"tags": [
"build_address:luci.chromium.ci/win-official/1157",
"builder:win-official",
"buildset:commit/git/bc1447c707885cd7adcdd7a7f563d06005cde399",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/bc1447c707885cd7adcdd7a7f563d06005cde399",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9026544369437236224",
"scheduler_job_id:chromium/win-official",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8861114307055191952/+/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": "1607779893157200",
"url": "https://ci.chromium.org/b/8861114307055191952",
"utcnow_ts": "1607779893276430"
}
}
[13:31:33.283] Task URL: https://ci.chromium.org/b/8861114307055191952
[13:31:33.283] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:2:0) after 1m0s
[13:32:33.363] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:2:0)
[13:32:33.363] Timer tick, asking Buildbucket for the build status
[13:32:33.509] Build 8861114307055191952: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:32:33.509] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:3:0) after 1m0s
[13:32:49.273] Received PubSub notification, asking Buildbucket for the build status
[13:32:49.527] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:33:33.615] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:3:0)
[13:33:33.615] Timer tick, asking Buildbucket for the build status
[13:33:33.687] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:33:33.687] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:5:0) after 1m0s
[13:34:33.799] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:5:0)
[13:34:33.799] Timer tick, asking Buildbucket for the build status
[13:34:33.873] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:34:33.873] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:6:0) after 1m0s
[13:35:33.976] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:6:0)
[13:35:33.976] Timer tick, asking Buildbucket for the build status
[13:35:34.044] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:35:34.044] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:7:0) after 1m0s
[13:36:34.029] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:7:0)
[13:36:34.029] Timer tick, asking Buildbucket for the build status
[13:36:34.094] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:36:34.094] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:8:0) after 1m0s
[13:37:34.222] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:8:0)
[13:37:34.222] Timer tick, asking Buildbucket for the build status
[13:37:34.345] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:37:34.345] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:9:0) after 1m0s
[13:38:34.478] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:9:0)
[13:38:34.478] Timer tick, asking Buildbucket for the build status
[13:38:34.598] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:38:34.598] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:10:0) after 1m0s
[13:39:34.751] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:10:0)
[13:39:34.751] Timer tick, asking Buildbucket for the build status
[13:39:34.836] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:39:34.836] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:11:0) after 1m0s
[13:40:34.968] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:11:0)
[13:40:34.969] Timer tick, asking Buildbucket for the build status
[13:40:35.043] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:40:35.043] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:12:0) after 1m0s
[13:41:35.170] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:12:0)
[13:41:35.170] Timer tick, asking Buildbucket for the build status
[13:41:35.252] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:41:35.252] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:13:0) after 1m0s
[13:42:35.359] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:13:0)
[13:42:35.359] Timer tick, asking Buildbucket for the build status
[13:42:35.437] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:42:35.437] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:14:0) after 1m0s
[13:43:35.505] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:14:0)
[13:43:35.505] Timer tick, asking Buildbucket for the build status
[13:43:35.599] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:43:35.599] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:15:0) after 1m0s
[13:44:35.653] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:15:0)
[13:44:35.653] Timer tick, asking Buildbucket for the build status
[13:44:36.110] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:44:36.110] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:16:0) after 1m0s
[13:45:36.079] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:16:0)
[13:45:36.079] Timer tick, asking Buildbucket for the build status
[13:45:36.149] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:45:36.149] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:17:0) after 1m0s
[13:46:36.168] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:17:0)
[13:46:36.168] Timer tick, asking Buildbucket for the build status
[13:46:36.275] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:46:36.275] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:18:0) after 1m0s
[13:47:36.313] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:18:0)
[13:47:36.313] Timer tick, asking Buildbucket for the build status
[13:47:36.510] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:47:36.510] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:19:0) after 1m0s
[13:48:36.530] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:19:0)
[13:48:36.530] Timer tick, asking Buildbucket for the build status
[13:48:36.708] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:48:36.709] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:20:0) after 1m0s
[13:49:36.779] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:20:0)
[13:49:36.779] Timer tick, asking Buildbucket for the build status
[13:49:36.906] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:49:36.906] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:21:0) after 1m0s
[13:50:36.926] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:21:0)
[13:50:36.926] Timer tick, asking Buildbucket for the build status
[13:50:36.984] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:50:36.984] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:22:0) after 1m0s
[13:51:37.023] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:22:0)
[13:51:37.023] Timer tick, asking Buildbucket for the build status
[13:51:37.297] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:51:37.297] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:23:0) after 1m0s
[13:52:37.326] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:23:0)
[13:52:37.326] Timer tick, asking Buildbucket for the build status
[13:52:37.534] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:52:37.534] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:24:0) after 1m0s
[13:53:37.573] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:24:0)
[13:53:37.573] Timer tick, asking Buildbucket for the build status
[13:53:37.869] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:53:37.869] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:25:0) after 1m0s
[13:54:37.940] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:25:0)
[13:54:37.940] Timer tick, asking Buildbucket for the build status
[13:54:38.042] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:54:38.042] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:26:0) after 1m0s
[13:55:38.108] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:26:0)
[13:55:38.108] Timer tick, asking Buildbucket for the build status
[13:55:38.174] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:55:38.174] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:27:0) after 1m0s
[13:56:38.199] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:27:0)
[13:56:38.199] Timer tick, asking Buildbucket for the build status
[13:56:38.344] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:56:38.344] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:28:0) after 1m0s
[13:57:38.464] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:28:0)
[13:57:38.464] Timer tick, asking Buildbucket for the build status
[13:57:38.615] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:57:38.615] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:29:0) after 1m0s
[13:58:38.755] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:29:0)
[13:58:38.755] Timer tick, asking Buildbucket for the build status
[13:58:38.820] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:58:38.820] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:30:0) after 1m0s
[13:59:38.955] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:30:0)
[13:59:38.955] Timer tick, asking Buildbucket for the build status
[13:59:39.032] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:59:39.032] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:31:0) after 1m0s
[14:00:39.158] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:31:0)
[14:00:39.158] Timer tick, asking Buildbucket for the build status
[14:00:39.213] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:00:39.213] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:32:0) after 1m0s
[14:01:39.445] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:32:0)
[14:01:39.445] Timer tick, asking Buildbucket for the build status
[14:01:39.706] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:01:39.706] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:33:0) after 1m0s
[14:02:40.185] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:33:0)
[14:02:40.185] Timer tick, asking Buildbucket for the build status
[14:02:40.248] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:02:40.248] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:34:0) after 1m0s
[14:03:40.585] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:34:0)
[14:03:40.585] Timer tick, asking Buildbucket for the build status
[14:03:40.659] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:03:40.659] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:35:0) after 1m0s
[14:04:40.692] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:35:0)
[14:04:40.692] Timer tick, asking Buildbucket for the build status
[14:04:40.756] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:04:40.756] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:36:0) after 1m0s
[14:05:40.760] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:36:0)
[14:05:40.760] Timer tick, asking Buildbucket for the build status
[14:05:40.816] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:05:40.816] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:37:0) after 1m0s
[14:06:40.854] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:37:0)
[14:06:40.854] Timer tick, asking Buildbucket for the build status
[14:06:40.943] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:06:40.943] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:38:0) after 1m0s
[14:07:41.004] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:38:0)
[14:07:41.004] Timer tick, asking Buildbucket for the build status
[14:07:41.097] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:07:41.097] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:39:0) after 1m0s
[14:08:41.193] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:39:0)
[14:08:41.193] Timer tick, asking Buildbucket for the build status
[14:08:41.308] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:08:41.308] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:40:0) after 1m0s
[14:09:41.293] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:40:0)
[14:09:41.293] Timer tick, asking Buildbucket for the build status
[14:09:41.527] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:09:41.527] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:41:0) after 1m0s
[14:10:41.579] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:41:0)
[14:10:41.579] Timer tick, asking Buildbucket for the build status
[14:10:41.721] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:10:41.721] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:42:0) after 1m0s
[14:11:41.807] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:42:0)
[14:11:41.807] Timer tick, asking Buildbucket for the build status
[14:11:42.039] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:11:42.039] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:43:0) after 1m0s
[14:12:42.042] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:43:0)
[14:12:42.042] Timer tick, asking Buildbucket for the build status
[14:12:42.131] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:12:42.132] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:44:0) after 1m0s
[14:13:42.199] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:44:0)
[14:13:42.199] Timer tick, asking Buildbucket for the build status
[14:13:42.261] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:13:42.261] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:45:0) after 1m0s
[14:14:42.255] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:45:0)
[14:14:42.255] Timer tick, asking Buildbucket for the build status
[14:14:42.310] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:14:42.310] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:46:0) after 1m0s
[14:15:42.423] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:46:0)
[14:15:42.423] Timer tick, asking Buildbucket for the build status
[14:15:42.486] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:15:42.486] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:47:0) after 1m0s
[14:16:42.575] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:47:0)
[14:16:42.575] Timer tick, asking Buildbucket for the build status
[14:16:42.736] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:16:42.736] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:48:0) after 1m0s
[14:17:42.778] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:48:0)
[14:17:42.778] Timer tick, asking Buildbucket for the build status
[14:17:42.846] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:17:42.846] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:49:0) after 1m0s
[14:18:42.891] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:49:0)
[14:18:42.891] Timer tick, asking Buildbucket for the build status
[14:18:43.032] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:18:43.032] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:50:0) after 1m0s
[14:19:43.097] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:50:0)
[14:19:43.097] Timer tick, asking Buildbucket for the build status
[14:19:43.154] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:19:43.154] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:51:0) after 1m0s
[14:20:43.158] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:51:0)
[14:20:43.158] Timer tick, asking Buildbucket for the build status
[14:20:43.221] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:20:43.221] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:52:0) after 1m0s
[14:21:43.193] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:52:0)
[14:21:43.193] Timer tick, asking Buildbucket for the build status
[14:21:43.539] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:21:43.539] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:53:0) after 1m0s
[14:22:43.529] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:53:0)
[14:22:43.529] Timer tick, asking Buildbucket for the build status
[14:22:43.913] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:22:43.913] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:54:0) after 1m0s
[14:23:43.923] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:54:0)
[14:23:43.923] Timer tick, asking Buildbucket for the build status
[14:23:44.089] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:23:44.089] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:55:0) after 1m0s
[14:24:44.106] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:55:0)
[14:24:44.106] Timer tick, asking Buildbucket for the build status
[14:24:44.189] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:24:44.189] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:56:0) after 1m0s
[14:25:44.273] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:56:0)
[14:25:44.274] Timer tick, asking Buildbucket for the build status
[14:25:44.515] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:25:44.515] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:57:0) after 1m0s
[14:26:44.580] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:57:0)
[14:26:44.580] Timer tick, asking Buildbucket for the build status
[14:26:44.675] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:26:44.675] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:58:0) after 1m0s
[14:27:44.707] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:58:0)
[14:27:44.707] Timer tick, asking Buildbucket for the build status
[14:27:44.768] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:27:44.768] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:59:0) after 1m0s
[14:28:44.776] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:59:0)
[14:28:44.776] Timer tick, asking Buildbucket for the build status
[14:28:44.842] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:28:44.842] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:60:0) after 1m0s
[14:29:44.856] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:60:0)
[14:29:44.856] Timer tick, asking Buildbucket for the build status
[14:29:45.130] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:29:45.130] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:61:0) after 1m0s
[14:30:45.187] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:61:0)
[14:30:45.187] Timer tick, asking Buildbucket for the build status
[14:30:45.258] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:30:45.258] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:62:0) after 1m0s
[14:31:45.261] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:62:0)
[14:31:45.261] Timer tick, asking Buildbucket for the build status
[14:31:45.611] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:31:45.611] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:63:0) after 1m0s
[14:32:45.632] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:63:0)
[14:32:45.632] Timer tick, asking Buildbucket for the build status
[14:32:45.696] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:32:45.696] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:64:0) after 1m0s
[14:33:45.713] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:64:0)
[14:33:45.713] Timer tick, asking Buildbucket for the build status
[14:33:45.766] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:33:45.766] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:65:0) after 1m0s
[14:34:45.790] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:65:0)
[14:34:45.790] Timer tick, asking Buildbucket for the build status
[14:34:45.905] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:34:45.905] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:66:0) after 1m0s
[14:35:46.025] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:66:0)
[14:35:46.025] Timer tick, asking Buildbucket for the build status
[14:35:46.089] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:35:46.089] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:67:0) after 1m0s
[14:36:46.178] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:67:0)
[14:36:46.178] Timer tick, asking Buildbucket for the build status
[14:36:46.260] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:36:46.260] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:68:0) after 1m0s
[14:37:46.280] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:68:0)
[14:37:46.280] Timer tick, asking Buildbucket for the build status
[14:37:46.359] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:37:46.359] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:69:0) after 1m0s
[14:38:46.427] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:69:0)
[14:38:46.427] Timer tick, asking Buildbucket for the build status
[14:38:46.482] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:38:46.482] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:70:0) after 1m0s
[14:39:46.552] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:70:0)
[14:39:46.552] Timer tick, asking Buildbucket for the build status
[14:39:46.650] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:39:46.650] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:71:0) after 1m0s
[14:40:46.628] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:71:0)
[14:40:46.628] Timer tick, asking Buildbucket for the build status
[14:40:46.687] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:40:46.688] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:72:0) after 1m0s
[14:41:46.741] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:72:0)
[14:41:46.741] Timer tick, asking Buildbucket for the build status
[14:41:46.841] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:41:46.841] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:73:0) after 1m0s
[14:42:46.961] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:73:0)
[14:42:46.961] Timer tick, asking Buildbucket for the build status
[14:42:47.052] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:42:47.052] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:74:0) after 1m0s
[14:43:48.337] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:74:0)
[14:43:48.337] Timer tick, asking Buildbucket for the build status
[14:43:48.600] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:43:48.600] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:75:0) after 1m0s
[14:44:48.751] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:75:0)
[14:44:48.751] Timer tick, asking Buildbucket for the build status
[14:44:48.811] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:44:48.811] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:76:0) after 1m0s
[14:45:48.892] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:76:0)
[14:45:48.892] Timer tick, asking Buildbucket for the build status
[14:45:49.028] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:45:49.028] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:77:0) after 1m0s
[14:46:49.187] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:77:0)
[14:46:49.187] Timer tick, asking Buildbucket for the build status
[14:46:49.534] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:46:49.534] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:78:0) after 1m0s
[14:47:49.633] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:78:0)
[14:47:49.633] Timer tick, asking Buildbucket for the build status
[14:47:49.761] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:47:49.761] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:79:0) after 1m0s
[14:48:49.901] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:79:0)
[14:48:49.901] Timer tick, asking Buildbucket for the build status
[14:48:49.962] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:48:49.962] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:80:0) after 1m0s
[14:49:49.986] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:80:0)
[14:49:49.986] Timer tick, asking Buildbucket for the build status
[14:49:50.050] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:49:50.050] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:81:0) after 1m0s
[14:50:50.140] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:81:0)
[14:50:50.140] Timer tick, asking Buildbucket for the build status
[14:50:50.415] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:50:50.415] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:82:0) after 1m0s
[14:51:50.484] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:82:0)
[14:51:50.484] Timer tick, asking Buildbucket for the build status
[14:51:50.565] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:51:50.565] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:83:0) after 1m0s
[14:52:50.763] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:83:0)
[14:52:50.763] Timer tick, asking Buildbucket for the build status
[14:52:50.837] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:52:50.837] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:84:0) after 1m0s
[14:53:50.976] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:84:0)
[14:53:50.976] Timer tick, asking Buildbucket for the build status
[14:53:51.048] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:53:51.048] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:85:0) after 1m0s
[14:54:51.065] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:85:0)
[14:54:51.065] Timer tick, asking Buildbucket for the build status
[14:54:51.123] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:54:51.123] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:86:0) after 1m0s
[14:55:51.204] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:86:0)
[14:55:51.204] Timer tick, asking Buildbucket for the build status
[14:55:51.262] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:55:51.262] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:87:0) after 1m0s
[14:56:51.358] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:87:0)
[14:56:51.358] Timer tick, asking Buildbucket for the build status
[14:56:51.603] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:56:51.603] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:88:0) after 1m0s
[14:57:51.675] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:88:0)
[14:57:51.675] Timer tick, asking Buildbucket for the build status
[14:57:51.744] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:57:51.744] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:89:0) after 1m0s
[14:58:51.867] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:89:0)
[14:58:51.867] Timer tick, asking Buildbucket for the build status
[14:58:52.125] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:58:52.125] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:90:0) after 1m0s
[14:59:52.261] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:90:0)
[14:59:52.261] Timer tick, asking Buildbucket for the build status
[14:59:52.314] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:59:52.314] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:91:0) after 1m0s
[15:00:52.335] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:91:0)
[15:00:52.335] Timer tick, asking Buildbucket for the build status
[15:00:52.736] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:00:52.736] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:92:0) after 1m0s
[15:01:52.811] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:92:0)
[15:01:52.811] Timer tick, asking Buildbucket for the build status
[15:01:52.906] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:01:52.906] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:93:0) after 1m0s
[15:02:52.974] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:93:0)
[15:02:52.974] Timer tick, asking Buildbucket for the build status
[15:02:53.316] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:02:53.316] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:94:0) after 1m0s
[15:03:53.374] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:94:0)
[15:03:53.374] Timer tick, asking Buildbucket for the build status
[15:03:53.550] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:03:53.550] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:95:0) after 1m0s
[15:04:53.574] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:95:0)
[15:04:53.574] Timer tick, asking Buildbucket for the build status
[15:04:53.631] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:04:53.631] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:96:0) after 1m0s
[15:05:53.704] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:96:0)
[15:05:53.704] Timer tick, asking Buildbucket for the build status
[15:05:53.762] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:05:53.762] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:97:0) after 1m0s
[15:06:53.882] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:97:0)
[15:06:53.882] Timer tick, asking Buildbucket for the build status
[15:06:54.209] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:06:54.209] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:98:0) after 1m0s
[15:07:54.267] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:98:0)
[15:07:54.267] Timer tick, asking Buildbucket for the build status
[15:07:54.331] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:07:54.331] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:99:0) after 1m0s
[15:08:54.527] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:99:0)
[15:08:54.527] Timer tick, asking Buildbucket for the build status
[15:08:54.819] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:08:54.819] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:100:0) after 1m0s
[15:09:54.870] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:100:0)
[15:09:54.870] Timer tick, asking Buildbucket for the build status
[15:09:54.930] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:09:54.930] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:101:0) after 1m0s
[15:10:54.959] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:101:0)
[15:10:54.959] Timer tick, asking Buildbucket for the build status
[15:10:55.033] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:10:55.033] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:102:0) after 1m0s
[15:11:55.130] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:102:0)
[15:11:55.130] Timer tick, asking Buildbucket for the build status
[15:11:55.496] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:11:55.496] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:103:0) after 1m0s
[15:12:55.544] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:103:0)
[15:12:55.544] Timer tick, asking Buildbucket for the build status
[15:12:55.629] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:12:55.629] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:104:0) after 1m0s
[15:13:55.733] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:104:0)
[15:13:55.733] Timer tick, asking Buildbucket for the build status
[15:13:55.841] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:13:55.841] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:105:0) after 1m0s
[15:14:55.956] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:105:0)
[15:14:55.956] Timer tick, asking Buildbucket for the build status
[15:14:56.909] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:14:56.909] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:106:0) after 1m0s
[15:15:57.017] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:106:0)
[15:15:57.017] Timer tick, asking Buildbucket for the build status
[15:15:57.085] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:15:57.085] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:107:0) after 1m0s
[15:16:57.205] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:107:0)
[15:16:57.205] Timer tick, asking Buildbucket for the build status
[15:16:57.491] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:16:57.491] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:108:0) after 1m0s
[15:17:57.618] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:108:0)
[15:17:57.618] Timer tick, asking Buildbucket for the build status
[15:17:57.933] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:17:57.933] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:109:0) after 1m0s
[15:18:58.007] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:109:0)
[15:18:58.007] Timer tick, asking Buildbucket for the build status
[15:18:58.068] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:18:58.068] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:110:0) after 1m0s
[15:19:58.108] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:110:0)
[15:19:58.108] Timer tick, asking Buildbucket for the build status
[15:19:58.170] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:19:58.170] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:111:0) after 1m0s
[15:20:58.246] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:111:0)
[15:20:58.246] Timer tick, asking Buildbucket for the build status
[15:20:58.309] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:20:58.309] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:112:0) after 1m0s
[15:21:58.396] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:112:0)
[15:21:58.396] Timer tick, asking Buildbucket for the build status
[15:21:58.484] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:21:58.484] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:113:0) after 1m0s
[15:22:58.724] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:113:0)
[15:22:58.724] Timer tick, asking Buildbucket for the build status
[15:22:58.777] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:22:58.777] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:114:0) after 1m0s
[15:23:58.851] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:114:0)
[15:23:58.851] Timer tick, asking Buildbucket for the build status
[15:23:58.902] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:23:58.902] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:115:0) after 1m0s
[15:24:58.932] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:115:0)
[15:24:58.932] Timer tick, asking Buildbucket for the build status
[15:24:58.986] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:24:58.986] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:116:0) after 1m0s
[15:25:59.160] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:116:0)
[15:25:59.160] Timer tick, asking Buildbucket for the build status
[15:25:59.212] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:25:59.212] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:117:0) after 1m0s
[15:26:59.233] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:117:0)
[15:26:59.233] Timer tick, asking Buildbucket for the build status
[15:26:59.501] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:26:59.501] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:118:0) after 1m0s
[15:27:59.522] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:118:0)
[15:27:59.522] Timer tick, asking Buildbucket for the build status
[15:27:59.576] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:27:59.576] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:119:0) after 1m0s
[15:28:59.598] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:119:0)
[15:28:59.598] Timer tick, asking Buildbucket for the build status
[15:28:59.716] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:28:59.716] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:120:0) after 1m0s
[15:29:59.872] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:120:0)
[15:29:59.872] Timer tick, asking Buildbucket for the build status
[15:29:59.930] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:29:59.930] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:121:0) after 1m0s
[15:30:59.979] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:121:0)
[15:30:59.980] Timer tick, asking Buildbucket for the build status
[15:31:00.206] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:31:00.206] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:122:0) after 1m0s
[15:32:00.772] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:122:0)
[15:32:00.772] Timer tick, asking Buildbucket for the build status
[15:32:00.908] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:32:00.908] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:123:0) after 1m0s
[15:33:00.936] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:123:0)
[15:33:00.936] Timer tick, asking Buildbucket for the build status
[15:33:01.148] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:33:01.148] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:124:0) after 1m0s
[15:34:01.218] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:124:0)
[15:34:01.218] Timer tick, asking Buildbucket for the build status
[15:34:01.273] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:34:01.273] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:125:0) after 1m0s
[15:35:01.333] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:125:0)
[15:35:01.333] Timer tick, asking Buildbucket for the build status
[15:35:01.652] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:35:01.652] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:126:0) after 1m0s
[15:36:01.721] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:126:0)
[15:36:01.721] Timer tick, asking Buildbucket for the build status
[15:36:01.914] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:36:01.914] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:127:0) after 1m0s
[15:37:01.967] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:127:0)
[15:37:01.967] Timer tick, asking Buildbucket for the build status
[15:37:02.220] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:37:02.220] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:128:0) after 1m0s
[15:38:02.231] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:128:0)
[15:38:02.231] Timer tick, asking Buildbucket for the build status
[15:38:02.287] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:38:02.287] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:129:0) after 1m0s
[15:39:02.337] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:129:0)
[15:39:02.337] Timer tick, asking Buildbucket for the build status
[15:39:02.394] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:39:02.394] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:130:0) after 1m0s
[15:40:02.414] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:130:0)
[15:40:02.414] Timer tick, asking Buildbucket for the build status
[15:40:02.486] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:40:02.486] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:131:0) after 1m0s
[15:41:02.505] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:131:0)
[15:41:02.505] Timer tick, asking Buildbucket for the build status
[15:41:02.567] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:41:02.567] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:132:0) after 1m0s
[15:42:02.611] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:132:0)
[15:42:02.611] Timer tick, asking Buildbucket for the build status
[15:42:02.979] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:42:02.979] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:133:0) after 1m0s
[15:43:03.052] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:133:0)
[15:43:03.052] Timer tick, asking Buildbucket for the build status
[15:43:03.131] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:43:03.131] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:134:0) after 1m0s
[15:44:03.274] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:134:0)
[15:44:03.274] Timer tick, asking Buildbucket for the build status
[15:44:03.345] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:44:03.345] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:135:0) after 1m0s
[15:45:03.405] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:135:0)
[15:45:03.405] Timer tick, asking Buildbucket for the build status
[15:45:03.709] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:45:03.709] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:136:0) after 1m0s
[15:46:03.768] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:136:0)
[15:46:03.768] Timer tick, asking Buildbucket for the build status
[15:46:03.832] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:46:03.832] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:137:0) after 1m0s
[15:47:03.893] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:137:0)
[15:47:03.893] Timer tick, asking Buildbucket for the build status
[15:47:04.377] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:47:04.377] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:138:0) after 1m0s
[15:48:04.447] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:138:0)
[15:48:04.447] Timer tick, asking Buildbucket for the build status
[15:48:04.525] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:48:04.525] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:139:0) after 1m0s
[15:49:04.544] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:139:0)
[15:49:04.544] Timer tick, asking Buildbucket for the build status
[15:49:04.628] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:49:04.628] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:140:0) after 1m0s
[15:50:04.651] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:140:0)
[15:50:04.651] Timer tick, asking Buildbucket for the build status
[15:50:04.730] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:50:04.730] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:141:0) after 1m0s
[15:51:04.721] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:141:0)
[15:51:04.721] Timer tick, asking Buildbucket for the build status
[15:51:04.802] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:51:04.802] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:142:0) after 1m0s
[15:52:04.912] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:142:0)
[15:52:04.912] Timer tick, asking Buildbucket for the build status
[15:52:05.033] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:52:05.033] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:143:0) after 1m0s
[15:53:05.056] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:143:0)
[15:53:05.056] Timer tick, asking Buildbucket for the build status
[15:53:05.226] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:53:05.226] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:144:0) after 1m0s
[15:54:05.263] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:144:0)
[15:54:05.263] Timer tick, asking Buildbucket for the build status
[15:54:05.340] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:54:05.340] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:145:0) after 1m0s
[15:55:05.375] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:145:0)
[15:55:05.375] Timer tick, asking Buildbucket for the build status
[15:55:05.443] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:55:05.443] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:146:0) after 1m0s
[15:56:05.486] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:146:0)
[15:56:05.486] Timer tick, asking Buildbucket for the build status
[15:56:05.557] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:56:05.557] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:147:0) after 1m0s
[15:57:05.579] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:147:0)
[15:57:05.579] Timer tick, asking Buildbucket for the build status
[15:57:05.827] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:57:05.827] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:148:0) after 1m0s
[15:58:05.870] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:148:0)
[15:58:05.871] Timer tick, asking Buildbucket for the build status
[15:58:05.944] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:58:05.944] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:149:0) after 1m0s
[15:59:05.974] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:149:0)
[15:59:05.974] Timer tick, asking Buildbucket for the build status
[15:59:06.112] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:59:06.112] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:150:0) after 1m0s
[16:00:06.137] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:150:0)
[16:00:06.137] Timer tick, asking Buildbucket for the build status
[16:00:06.401] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:00:06.401] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:151:0) after 1m0s
[16:01:06.468] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:151:0)
[16:01:06.468] Timer tick, asking Buildbucket for the build status
[16:01:06.524] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:01:06.524] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:152:0) after 1m0s
[16:02:06.735] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:152:0)
[16:02:06.735] Timer tick, asking Buildbucket for the build status
[16:02:06.843] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:02:06.843] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:153:0) after 1m0s
[16:03:06.887] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:153:0)
[16:03:06.887] Timer tick, asking Buildbucket for the build status
[16:03:06.961] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:03:06.961] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:154:0) after 1m0s
[16:04:07.101] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:154:0)
[16:04:07.101] Timer tick, asking Buildbucket for the build status
[16:04:07.165] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:04:07.165] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:155:0) after 1m0s
[16:05:07.256] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:155:0)
[16:05:07.256] Timer tick, asking Buildbucket for the build status
[16:05:07.350] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:05:07.350] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:156:0) after 1m0s
[16:06:07.384] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:156:0)
[16:06:07.384] Timer tick, asking Buildbucket for the build status
[16:06:07.448] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:06:07.448] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:157:0) after 1m0s
[16:07:07.543] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:157:0)
[16:07:07.543] Timer tick, asking Buildbucket for the build status
[16:07:07.917] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:07:07.917] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:158:0) after 1m0s
[16:08:07.941] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:158:0)
[16:08:07.941] Timer tick, asking Buildbucket for the build status
[16:08:08.007] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:08:08.007] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:159:0) after 1m0s
[16:09:08.038] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:159:0)
[16:09:08.038] Timer tick, asking Buildbucket for the build status
[16:09:08.097] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:09:08.097] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:160:0) after 1m0s
[16:10:08.110] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:160:0)
[16:10:08.110] Timer tick, asking Buildbucket for the build status
[16:10:08.316] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:10:08.316] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:161:0) after 1m0s
[16:11:08.367] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:161:0)
[16:11:08.367] Timer tick, asking Buildbucket for the build status
[16:11:08.437] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:11:08.437] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:162:0) after 1m0s
[16:12:08.456] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:162:0)
[16:12:08.456] Timer tick, asking Buildbucket for the build status
[16:12:08.589] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:12:08.589] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:163:0) after 1m0s
[16:13:08.614] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:163:0)
[16:13:08.614] Timer tick, asking Buildbucket for the build status
[16:13:08.676] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:13:08.676] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:164:0) after 1m0s
[16:14:08.671] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:164:0)
[16:14:08.671] Timer tick, asking Buildbucket for the build status
[16:14:08.846] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:14:08.846] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:165:0) after 1m0s
[16:15:08.871] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:165:0)
[16:15:08.871] Timer tick, asking Buildbucket for the build status
[16:15:09.040] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:15:09.040] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:166:0) after 1m0s
[16:16:09.129] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:166:0)
[16:16:09.129] Timer tick, asking Buildbucket for the build status
[16:16:09.245] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:16:09.245] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:167:0) after 1m0s
[16:17:09.267] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:167:0)
[16:17:09.267] Timer tick, asking Buildbucket for the build status
[16:17:09.504] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:17:09.504] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:168:0) after 1m0s
[16:18:09.871] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:168:0)
[16:18:09.871] Timer tick, asking Buildbucket for the build status
[16:18:09.935] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:18:09.935] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:169:0) after 1m0s
[16:19:10.077] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:169:0)
[16:19:10.077] Timer tick, asking Buildbucket for the build status
[16:19:10.288] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:19:10.288] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:170:0) after 1m0s
[16:20:10.537] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:170:0)
[16:20:10.537] Timer tick, asking Buildbucket for the build status
[16:20:10.625] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:20:10.625] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:171:0) after 1m0s
[16:21:10.839] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:171:0)
[16:21:10.839] Timer tick, asking Buildbucket for the build status
[16:21:10.939] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:21:10.939] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:172:0) after 1m0s
[16:22:10.997] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:172:0)
[16:22:10.997] Timer tick, asking Buildbucket for the build status
[16:22:11.469] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:22:11.469] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:173:0) after 1m0s
[16:23:11.543] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:173:0)
[16:23:11.543] Timer tick, asking Buildbucket for the build status
[16:23:11.617] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:23:11.617] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:174:0) after 1m0s
[16:24:11.671] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:174:0)
[16:24:11.671] Timer tick, asking Buildbucket for the build status
[16:24:11.750] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:24:11.750] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:175:0) after 1m0s
[16:25:11.771] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:175:0)
[16:25:11.771] Timer tick, asking Buildbucket for the build status
[16:25:11.884] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:25:11.884] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:176:0) after 1m0s
[16:26:11.970] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:176:0)
[16:26:11.970] Timer tick, asking Buildbucket for the build status
[16:26:12.048] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:26:12.048] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:177:0) after 1m0s
[16:27:12.189] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:177:0)
[16:27:12.189] Timer tick, asking Buildbucket for the build status
[16:27:12.357] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:27:12.357] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:178:0) after 1m0s
[16:28:12.385] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:178:0)
[16:28:12.385] Timer tick, asking Buildbucket for the build status
[16:28:12.483] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:28:12.483] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:179:0) after 1m0s
[16:29:12.740] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:179:0)
[16:29:12.740] Timer tick, asking Buildbucket for the build status
[16:29:12.806] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:29:12.806] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:180:0) after 1m0s
[16:30:12.950] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:180:0)
[16:30:12.950] Timer tick, asking Buildbucket for the build status
[16:30:13.024] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:30:13.024] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:181:0) after 1m0s
[16:31:13.220] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:181:0)
[16:31:13.220] Timer tick, asking Buildbucket for the build status
[16:31:13.286] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:31:13.286] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:182:0) after 1m0s
[16:32:13.427] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:182:0)
[16:32:13.427] Timer tick, asking Buildbucket for the build status
[16:32:13.604] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:32:13.604] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:183:0) after 1m0s
[16:33:14.457] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:183:0)
[16:33:14.457] Timer tick, asking Buildbucket for the build status
[16:33:14.506] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:33:14.506] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:184:0) after 1m0s
[16:34:14.735] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:184:0)
[16:34:14.735] Timer tick, asking Buildbucket for the build status
[16:34:14.905] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:34:14.905] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:185:0) after 1m0s
[16:35:15.011] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:185:0)
[16:35:15.011] Timer tick, asking Buildbucket for the build status
[16:35:15.137] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:35:15.137] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:186:0) after 1m0s
[16:36:15.195] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:186:0)
[16:36:15.195] Timer tick, asking Buildbucket for the build status
[16:36:15.414] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:36:15.414] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:187:0) after 1m0s
[16:37:15.527] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:187:0)
[16:37:15.527] Timer tick, asking Buildbucket for the build status
[16:37:15.650] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:37:15.650] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:188:0) after 1m0s
[16:38:15.850] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:188:0)
[16:38:15.850] Timer tick, asking Buildbucket for the build status
[16:38:15.919] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:38:15.919] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:189:0) after 1m0s
[16:39:15.994] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:189:0)
[16:39:15.994] Timer tick, asking Buildbucket for the build status
[16:39:16.055] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:39:16.055] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:190:0) after 1m0s
[16:40:16.103] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:190:0)
[16:40:16.103] Timer tick, asking Buildbucket for the build status
[16:40:16.175] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:40:16.175] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:191:0) after 1m0s
[16:41:16.451] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:191:0)
[16:41:16.451] Timer tick, asking Buildbucket for the build status
[16:41:16.516] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:41:16.516] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:192:0) after 1m0s
[16:42:16.742] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:192:0)
[16:42:16.742] Timer tick, asking Buildbucket for the build status
[16:42:16.843] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:42:16.843] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:193:0) after 1m0s
[16:43:16.909] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:193:0)
[16:43:16.909] Timer tick, asking Buildbucket for the build status
[16:43:16.966] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:43:16.966] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:194:0) after 1m0s
[16:44:17.101] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:194:0)
[16:44:17.101] Timer tick, asking Buildbucket for the build status
[16:44:17.287] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:44:17.287] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:195:0) after 1m0s
[16:45:17.381] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:195:0)
[16:45:17.381] Timer tick, asking Buildbucket for the build status
[16:45:17.448] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:45:17.448] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:196:0) after 1m0s
[16:46:17.484] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:196:0)
[16:46:17.484] Timer tick, asking Buildbucket for the build status
[16:46:17.567] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:46:17.567] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:197:0) after 1m0s
[16:47:17.640] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:197:0)
[16:47:17.640] Timer tick, asking Buildbucket for the build status
[16:47:17.823] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:47:17.823] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:198:0) after 1m0s
[16:48:17.878] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:198:0)
[16:48:17.878] Timer tick, asking Buildbucket for the build status
[16:48:17.936] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:48:17.936] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:199:0) after 1m0s
[16:49:18.025] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:199:0)
[16:49:18.025] Timer tick, asking Buildbucket for the build status
[16:49:18.198] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:49:18.199] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:200:0) after 1m0s
[16:50:18.307] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:200:0)
[16:50:18.307] Timer tick, asking Buildbucket for the build status
[16:50:18.363] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:50:18.363] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:201:0) after 1m0s
[16:51:18.528] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:201:0)
[16:51:18.528] Timer tick, asking Buildbucket for the build status
[16:51:18.591] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:51:18.591] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:202:0) after 1m0s
[16:52:18.690] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:202:0)
[16:52:18.690] Timer tick, asking Buildbucket for the build status
[16:52:18.935] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:52:18.935] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:203:0) after 1m0s
[16:53:19.038] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:203:0)
[16:53:19.038] Timer tick, asking Buildbucket for the build status
[16:53:19.097] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:53:19.097] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:204:0) after 1m0s
[16:54:19.158] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:204:0)
[16:54:19.158] Timer tick, asking Buildbucket for the build status
[16:54:19.297] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:54:19.297] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:205:0) after 1m0s
[16:55:19.328] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:205:0)
[16:55:19.328] Timer tick, asking Buildbucket for the build status
[16:55:19.412] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:55:19.412] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:206:0) after 1m0s
[16:56:19.485] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:206:0)
[16:56:19.485] Timer tick, asking Buildbucket for the build status
[16:56:19.573] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:56:19.573] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:207:0) after 1m0s
[16:57:19.623] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:207:0)
[16:57:19.623] Timer tick, asking Buildbucket for the build status
[16:57:19.734] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:57:19.734] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:208:0) after 1m0s
[16:58:19.876] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:208:0)
[16:58:19.876] Timer tick, asking Buildbucket for the build status
[16:58:20.022] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:58:20.022] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:209:0) after 1m0s
[16:59:20.072] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:209:0)
[16:59:20.072] Timer tick, asking Buildbucket for the build status
[16:59:20.132] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:59:20.132] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:210:0) after 1m0s
[17:00:20.219] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:210:0)
[17:00:20.219] Timer tick, asking Buildbucket for the build status
[17:00:20.297] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:00:20.297] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:211:0) after 1m0s
[17:01:20.323] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:211:0)
[17:01:20.323] Timer tick, asking Buildbucket for the build status
[17:01:20.429] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:01:20.429] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:212:0) after 1m0s
[17:02:20.512] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:212:0)
[17:02:20.512] Timer tick, asking Buildbucket for the build status
[17:02:20.600] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:02:20.601] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:213:0) after 1m0s
[17:03:20.626] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:213:0)
[17:03:20.626] Timer tick, asking Buildbucket for the build status
[17:03:20.695] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:03:20.695] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:214:0) after 1m0s
[17:04:20.756] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:214:0)
[17:04:20.756] Timer tick, asking Buildbucket for the build status
[17:04:20.839] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:04:20.839] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:215:0) after 1m0s
[17:05:20.846] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:215:0)
[17:05:20.846] Timer tick, asking Buildbucket for the build status
[17:05:20.913] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:05:20.913] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:216:0) after 1m0s
[17:06:20.972] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:216:0)
[17:06:20.972] Timer tick, asking Buildbucket for the build status
[17:06:21.148] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:06:21.148] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:217:0) after 1m0s
[17:07:21.180] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:217:0)
[17:07:21.180] Timer tick, asking Buildbucket for the build status
[17:07:22.746] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:07:22.746] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:218:0) after 1m0s
[17:08:22.814] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:218:0)
[17:08:22.814] Timer tick, asking Buildbucket for the build status
[17:08:22.871] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:08:22.871] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:219:0) after 1m0s
[17:09:22.928] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:219:0)
[17:09:22.928] Timer tick, asking Buildbucket for the build status
[17:09:23.121] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:09:23.121] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:220:0) after 1m0s
[17:10:23.162] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:220:0)
[17:10:23.162] Timer tick, asking Buildbucket for the build status
[17:10:23.234] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:10:23.234] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:221:0) after 1m0s
[17:11:23.262] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:221:0)
[17:11:23.262] Timer tick, asking Buildbucket for the build status
[17:11:23.324] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:11:23.324] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:222:0) after 1m0s
[17:12:23.346] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:222:0)
[17:12:23.346] Timer tick, asking Buildbucket for the build status
[17:12:23.450] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:12:23.450] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:223:0) after 1m0s
[17:13:23.474] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:223:0)
[17:13:23.474] Timer tick, asking Buildbucket for the build status
[17:13:23.615] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:13:23.615] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:224:0) after 1m0s
[17:14:23.643] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:224:0)
[17:14:23.643] Timer tick, asking Buildbucket for the build status
[17:14:23.701] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:14:23.701] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:225:0) after 1m0s
[17:15:23.736] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:225:0)
[17:15:23.736] Timer tick, asking Buildbucket for the build status
[17:15:23.796] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:15:23.796] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:226:0) after 1m0s
[17:16:23.820] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:226:0)
[17:16:23.820] Timer tick, asking Buildbucket for the build status
[17:16:23.875] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:16:23.875] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:227:0) after 1m0s
[17:17:23.901] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:227:0)
[17:17:23.901] Timer tick, asking Buildbucket for the build status
[17:17:23.996] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:17:23.996] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:228:0) after 1m0s
[17:18:24.056] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:228:0)
[17:18:24.056] Timer tick, asking Buildbucket for the build status
[17:18:24.119] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:18:24.119] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:229:0) after 1m0s
[17:19:24.152] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:229:0)
[17:19:24.152] Timer tick, asking Buildbucket for the build status
[17:19:24.215] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:19:24.215] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:230:0) after 1m0s
[17:20:24.258] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:230:0)
[17:20:24.258] Timer tick, asking Buildbucket for the build status
[17:20:24.329] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:20:24.329] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:231:0) after 1m0s
[17:21:24.412] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:231:0)
[17:21:24.412] Timer tick, asking Buildbucket for the build status
[17:21:24.513] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:21:24.513] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:232:0) after 1m0s
[17:22:24.537] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:232:0)
[17:22:24.537] Timer tick, asking Buildbucket for the build status
[17:22:24.739] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:22:24.739] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:233:0) after 1m0s
[17:23:24.788] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:233:0)
[17:23:24.788] Timer tick, asking Buildbucket for the build status
[17:23:24.909] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:23:24.909] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:234:0) after 1m0s
[17:24:24.944] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:234:0)
[17:24:24.944] Timer tick, asking Buildbucket for the build status
[17:24:25.010] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:24:25.011] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:235:0) after 1m0s
[17:25:25.033] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:235:0)
[17:25:25.033] Timer tick, asking Buildbucket for the build status
[17:25:25.208] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:25:25.208] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:236:0) after 1m0s
[17:26:25.299] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:236:0)
[17:26:25.299] Timer tick, asking Buildbucket for the build status
[17:26:25.533] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:26:25.533] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:237:0) after 1m0s
[17:27:25.555] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:237:0)
[17:27:25.555] Timer tick, asking Buildbucket for the build status
[17:27:25.652] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:27:25.652] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:238:0) after 1m0s
[17:28:25.735] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:238:0)
[17:28:25.735] Timer tick, asking Buildbucket for the build status
[17:28:25.786] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:28:25.786] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:239:0) after 1m0s
[17:29:25.812] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:239:0)
[17:29:25.812] Timer tick, asking Buildbucket for the build status
[17:29:25.868] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:29:25.868] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:240:0) after 1m0s
[17:30:25.950] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:240:0)
[17:30:25.950] Timer tick, asking Buildbucket for the build status
[17:30:26.143] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:30:26.143] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:241:0) after 1m0s
[17:31:26.168] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:241:0)
[17:31:26.168] Timer tick, asking Buildbucket for the build status
[17:31:26.248] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:31:26.248] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:242:0) after 1m0s
[17:32:26.276] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:242:0)
[17:32:26.276] Timer tick, asking Buildbucket for the build status
[17:32:26.900] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:32:26.900] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:243:0) after 1m0s
[17:33:26.961] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:243:0)
[17:33:26.961] Timer tick, asking Buildbucket for the build status
[17:33:27.021] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:33:27.021] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:244:0) after 1m0s
[17:34:27.131] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:244:0)
[17:34:27.131] Timer tick, asking Buildbucket for the build status
[17:34:27.191] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:34:27.191] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:245:0) after 1m0s
[17:35:27.326] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:245:0)
[17:35:27.326] Timer tick, asking Buildbucket for the build status
[17:35:27.383] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:35:27.383] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:246:0) after 1m0s
[17:36:27.643] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:246:0)
[17:36:27.643] Timer tick, asking Buildbucket for the build status
[17:36:27.697] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:36:27.697] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:247:0) after 1m0s
[17:37:27.755] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:247:0)
[17:37:27.755] Timer tick, asking Buildbucket for the build status
[17:37:27.851] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:37:27.851] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:248:0) after 1m0s
[17:38:28.009] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:248:0)
[17:38:28.009] Timer tick, asking Buildbucket for the build status
[17:38:28.067] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:38:28.067] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:249:0) after 1m0s
[17:39:28.125] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:249:0)
[17:39:28.125] Timer tick, asking Buildbucket for the build status
[17:39:28.268] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:39:28.268] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:250:0) after 1m0s
[17:40:28.485] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:250:0)
[17:40:28.485] Timer tick, asking Buildbucket for the build status
[17:40:28.554] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:40:28.554] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:251:0) after 1m0s
[17:41:28.622] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:251:0)
[17:41:28.622] Timer tick, asking Buildbucket for the build status
[17:41:28.703] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:41:28.703] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:252:0) after 1m0s
[17:42:28.765] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:252:0)
[17:42:28.765] Timer tick, asking Buildbucket for the build status
[17:42:28.855] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:42:28.855] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:253:0) after 1m0s
[17:43:28.942] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:253:0)
[17:43:28.942] Timer tick, asking Buildbucket for the build status
[17:43:29.010] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:43:29.010] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:254:0) after 1m0s
[17:44:29.034] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:254:0)
[17:44:29.034] Timer tick, asking Buildbucket for the build status
[17:44:29.094] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:44:29.094] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:255:0) after 1m0s
[17:45:29.122] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:255:0)
[17:45:29.122] Timer tick, asking Buildbucket for the build status
[17:45:29.181] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:45:29.181] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:256:0) after 1m0s
[17:46:29.248] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:256:0)
[17:46:29.248] Timer tick, asking Buildbucket for the build status
[17:46:29.313] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:46:29.313] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:257:0) after 1m0s
[17:47:29.442] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:257:0)
[17:47:29.442] Timer tick, asking Buildbucket for the build status
[17:47:29.649] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:47:29.649] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:258:0) after 1m0s
[17:48:29.739] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:258:0)
[17:48:29.739] Timer tick, asking Buildbucket for the build status
[17:48:29.870] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:48:29.870] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:259:0) after 1m0s
[17:49:29.887] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:259:0)
[17:49:29.887] Timer tick, asking Buildbucket for the build status
[17:49:29.950] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:49:29.950] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:260:0) after 1m0s
[17:50:30.000] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:260:0)
[17:50:30.000] Timer tick, asking Buildbucket for the build status
[17:50:30.195] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:50:30.195] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:261:0) after 1m0s
[17:51:30.370] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:261:0)
[17:51:30.370] Timer tick, asking Buildbucket for the build status
[17:51:30.436] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:51:30.436] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:262:0) after 1m0s
[17:52:30.569] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:262:0)
[17:52:30.569] Timer tick, asking Buildbucket for the build status
[17:52:30.676] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:52:30.677] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:263:0) after 1m0s
[17:53:30.733] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:263:0)
[17:53:30.733] Timer tick, asking Buildbucket for the build status
[17:53:30.789] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:53:30.789] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:264:0) after 1m0s
[17:54:30.844] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:264:0)
[17:54:30.844] Timer tick, asking Buildbucket for the build status
[17:54:30.893] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:54:30.893] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:265:0) after 1m0s
[17:55:30.974] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:265:0)
[17:55:30.974] Timer tick, asking Buildbucket for the build status
[17:55:31.037] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:55:31.037] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:266:0) after 1m0s
[17:56:31.069] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:266:0)
[17:56:31.069] Timer tick, asking Buildbucket for the build status
[17:56:31.390] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:56:31.391] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:267:0) after 1m0s
[17:57:31.467] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:267:0)
[17:57:31.467] Timer tick, asking Buildbucket for the build status
[17:57:31.588] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:57:31.588] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:268:0) after 1m0s
[17:58:31.649] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:268:0)
[17:58:31.649] Timer tick, asking Buildbucket for the build status
[17:58:31.817] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:58:31.817] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:269:0) after 1m0s
[17:59:31.842] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:269:0)
[17:59:31.842] Timer tick, asking Buildbucket for the build status
[17:59:32.015] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:59:32.015] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:270:0) after 1m0s
[18:00:31.993] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:270:0)
[18:00:31.993] Timer tick, asking Buildbucket for the build status
[18:00:32.062] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:00:32.062] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:271:0) after 1m0s
[18:01:32.066] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:271:0)
[18:01:32.066] Timer tick, asking Buildbucket for the build status
[18:01:32.174] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:01:32.175] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:272:0) after 1m0s
[18:02:32.256] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:272:0)
[18:02:32.256] Timer tick, asking Buildbucket for the build status
[18:02:32.681] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:02:32.681] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:273:0) after 1m0s
[18:03:32.694] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:273:0)
[18:03:32.694] Timer tick, asking Buildbucket for the build status
[18:03:33.321] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:03:33.321] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:274:0) after 1m0s
[18:04:33.340] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:274:0)
[18:04:33.340] Timer tick, asking Buildbucket for the build status
[18:04:33.393] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:04:33.393] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:275:0) after 1m0s
[18:05:33.419] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:275:0)
[18:05:33.419] Timer tick, asking Buildbucket for the build status
[18:05:33.477] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:05:33.477] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:276:0) after 1m0s
[18:06:33.498] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:276:0)
[18:06:33.498] Timer tick, asking Buildbucket for the build status
[18:06:33.570] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:06:33.570] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:277:0) after 1m0s
[18:07:33.642] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:277:0)
[18:07:33.642] Timer tick, asking Buildbucket for the build status
[18:07:33.747] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:07:33.747] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:278:0) after 1m0s
[18:08:33.862] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:278:0)
[18:08:33.862] Timer tick, asking Buildbucket for the build status
[18:08:34.068] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:08:34.068] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:279:0) after 1m0s
[18:09:34.097] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:279:0)
[18:09:34.097] Timer tick, asking Buildbucket for the build status
[18:09:34.197] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:09:34.197] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:280:0) after 1m0s
[18:10:34.229] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:280:0)
[18:10:34.229] Timer tick, asking Buildbucket for the build status
[18:10:34.292] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:10:34.292] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:281:0) after 1m0s
[18:11:34.334] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:281:0)
[18:11:34.334] Timer tick, asking Buildbucket for the build status
[18:11:34.516] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:11:34.516] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:282:0) after 1m0s
[18:12:34.570] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:282:0)
[18:12:34.570] Timer tick, asking Buildbucket for the build status
[18:12:34.996] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:12:34.996] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:283:0) after 1m0s
[18:13:35.033] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:283:0)
[18:13:35.033] Timer tick, asking Buildbucket for the build status
[18:13:35.103] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:13:35.103] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:284:0) after 1m0s
[18:14:35.132] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:284:0)
[18:14:35.132] Timer tick, asking Buildbucket for the build status
[18:14:35.187] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:14:35.187] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:285:0) after 1m0s
[18:15:35.784] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:285:0)
[18:15:35.784] Timer tick, asking Buildbucket for the build status
[18:15:35.859] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:15:35.859] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:286:0) after 1m0s
[18:16:36.134] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:286:0)
[18:16:36.134] Timer tick, asking Buildbucket for the build status
[18:16:36.192] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:16:36.192] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:287:0) after 1m0s
[18:17:36.395] Handling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:287:0)
[18:17:36.395] Timer tick, asking Buildbucket for the build status
[18:17:36.481] Build 8861114307055191952: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:17:36.481] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9026544369437236224:288:0) after 1m0s
[18:18:15.039] Received PubSub notification, asking Buildbucket for the build status
[18:18:15.802] Build 8861114307055191952: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[18:18:15.802] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1607797094124244",
"created_by": "project:chromium",
"created_ts": "1607779892829655",
"id": "8861114307055191952",
"parameters_json": "{\"builder_name\": \"win-official\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"bc1447c707885cd7adcdd7a7f563d06005cde399\"}}",
"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\": \"bc1447c707885cd7adcdd7a7f563d06005cde399\", \"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-4-g5pz\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium\", \"buildername\": \"win-official\", \"buildnumber\": 1157, \"got_angle_revision\": \"4fb29e83e02c5152ebc60733eb5351ea98c7097d\", \"got_dawn_revision\": \"9c52c2997c81ceb77bd014a1f7c0f6f22bdcfddb\", \"got_nacl_revision\": \"299d4780ec86121ff2a5368ed9435ade0e356e5e\", \"got_revision\": \"bc1447c707885cd7adcdd7a7f563d06005cde399\", \"got_revision_cp\": \"refs/heads/master@{#836430}\", \"got_swarming_client_revision\": \"1a072711d4388c62e02480fabc26c68c24494be9\", \"got_swiftshader_revision\": \"4f90750776f88d42c6ec2e5cef071d098fce3c15\", \"got_v8_revision\": \"e7e9e702c110a535bb2daa6cd60db7b7d62d8665\", \"got_v8_revision_cp\": \"refs/heads/8.9.143@{#1}\", \"got_webrtc_revision\": \"d7808f1c464a07c8f1e2f97ec7ee92fda998d590\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#32804}\", \"mirrored_builders\": [\"tryserver.chromium:win-official\"], \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"bc1447c707885cd7adcdd7a7f563d06005cde399\"}, \"swarming\": {\"bot_dimensions\": {\"builder\": [\"win-archive-dbg\", \"win-archive-rel\", \"win-official\", \"win32-archive-dbg\", \"win32-archive-rel\", \"win32-official\"], \"caches\": [\"builder_9b3ebe5fd1c5be87380c40d216747346a59b28cf26de183f0e8e2b32e944d3c8_v2\"], \"cores\": [\"32\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"win-dbg-4-g5pz\"], \"image\": [\"chrome-win10-1703-20092300-22ba5320847\"], \"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\": [\"5657-0417a3f\"], \"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": "1607779968550844",
"status": "COMPLETED",
"status_changed_ts": "1607797094423747",
"tags": [
"build_address:luci.chromium.ci/win-official/1157",
"builder:win-official",
"buildset:commit/git/bc1447c707885cd7adcdd7a7f563d06005cde399",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/bc1447c707885cd7adcdd7a7f563d06005cde399",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9026544369437236224",
"scheduler_job_id:chromium/win-official",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8861114307055191952/+/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:506ff7c9eae38010",
"user_agent:luci-scheduler"
],
"updated_ts": "1607797094505864",
"url": "https://ci.chromium.org/b/8861114307055191952",
"utcnow_ts": "1607797095231800"
}
}
[18:18:15.802] Invocation finished in 4h46m44.627098762s with status SUCCEEDED