[12:15:10.215] New invocation is queued and will start shortly
[12:15:11.367] Starting the invocation (attempt 1)
[12:15:11.415] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[12:15:11.416] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[12:15:11.416] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9032619169686305808",
"parameters_json": "{\"builder_name\":\"win-official\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"790c32c397ee5aa960a8bab673045be3838a60a0\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:win-official",
"scheduler_invocation_id:9032619169686305808",
"scheduler_job_id:chromium/win-official",
"user_agent:luci-scheduler",
"buildset:commit/git/790c32c397ee5aa960a8bab673045be3838a60a0",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/790c32c397ee5aa960a8bab673045be3838a60a0",
"gitiles_ref:refs/heads/master"
]
}
[12:15:20.872] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1601986512868750",
"id": "8867189106240989424",
"parameters_json": "{\"builder_name\": \"win-official\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"790c32c397ee5aa960a8bab673045be3838a60a0\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1601986518550986",
"tags": [
"build_address:luci.chromium.ci/win-official/751",
"builder:win-official",
"buildset:commit/git/790c32c397ee5aa960a8bab673045be3838a60a0",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/790c32c397ee5aa960a8bab673045be3838a60a0",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9032619169686305808",
"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/8867189106240989424/+/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": "1601986518551124",
"url": "https://ci.chromium.org/b/8867189106240989424",
"utcnow_ts": "1601986520800186"
}
}
[12:15:20.872] Task URL: https://ci.chromium.org/b/8867189106240989424
[12:15:20.872] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:2:0) after 1m0s
[12:15:39.888] Received PubSub notification, asking Buildbucket for the build status
[12:15:39.966] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:16:20.976] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:2:0)
[12:16:20.976] Timer tick, asking Buildbucket for the build status
[12:16:21.171] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:16:21.171] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:4:0) after 1m0s
[12:17:21.197] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:4:0)
[12:17:21.197] Timer tick, asking Buildbucket for the build status
[12:17:21.281] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:17:21.281] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:5:0) after 1m0s
[12:18:21.307] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:5:0)
[12:18:21.307] Timer tick, asking Buildbucket for the build status
[12:18:21.944] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:18:21.944] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:6:0) after 1m0s
[12:19:21.970] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:6:0)
[12:19:21.970] Timer tick, asking Buildbucket for the build status
[12:19:22.042] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:19:22.043] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:7:0) after 1m0s
[12:20:22.112] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:7:0)
[12:20:22.112] Timer tick, asking Buildbucket for the build status
[12:20:22.270] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:20:22.270] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:8:0) after 1m0s
[12:21:22.260] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:8:0)
[12:21:22.260] Timer tick, asking Buildbucket for the build status
[12:21:22.725] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:21:22.725] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:9:0) after 1m0s
[12:22:22.798] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:9:0)
[12:22:22.798] Timer tick, asking Buildbucket for the build status
[12:22:23.032] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:22:23.032] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:10:0) after 1m0s
[12:23:23.047] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:10:0)
[12:23:23.047] Timer tick, asking Buildbucket for the build status
[12:23:23.188] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:23:23.188] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:11:0) after 1m0s
[12:24:23.204] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:11:0)
[12:24:23.204] Timer tick, asking Buildbucket for the build status
[12:24:23.429] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:24:23.429] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:12:0) after 1m0s
[12:25:23.424] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:12:0)
[12:25:23.424] Timer tick, asking Buildbucket for the build status
[12:25:23.555] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:25:23.555] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:13:0) after 1m0s
[12:26:23.567] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:13:0)
[12:26:23.567] Timer tick, asking Buildbucket for the build status
[12:26:23.716] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:26:23.716] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:14:0) after 1m0s
[12:27:23.798] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:14:0)
[12:27:23.798] Timer tick, asking Buildbucket for the build status
[12:27:23.996] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:27:23.996] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:15:0) after 1m0s
[12:28:24.018] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:15:0)
[12:28:24.018] Timer tick, asking Buildbucket for the build status
[12:28:24.079] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:28:24.079] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:16:0) after 1m0s
[12:29:24.117] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:16:0)
[12:29:24.117] Timer tick, asking Buildbucket for the build status
[12:29:24.218] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:29:24.218] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:17:0) after 1m0s
[12:30:24.350] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:17:0)
[12:30:24.350] Timer tick, asking Buildbucket for the build status
[12:30:24.475] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:30:24.475] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:18:0) after 1m0s
[12:31:24.559] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:18:0)
[12:31:24.559] Timer tick, asking Buildbucket for the build status
[12:31:24.644] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:31:24.644] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:19:0) after 1m0s
[12:32:24.666] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:19:0)
[12:32:24.666] Timer tick, asking Buildbucket for the build status
[12:32:24.833] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:32:24.833] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:20:0) after 1m0s
[12:33:24.856] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:20:0)
[12:33:24.856] Timer tick, asking Buildbucket for the build status
[12:33:25.028] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:33:25.028] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:21:0) after 1m0s
[12:34:25.013] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:21:0)
[12:34:25.013] Timer tick, asking Buildbucket for the build status
[12:34:25.128] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:34:25.128] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:22:0) after 1m0s
[12:35:25.145] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:22:0)
[12:35:25.145] Timer tick, asking Buildbucket for the build status
[12:35:25.275] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:35:25.275] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:23:0) after 1m0s
[12:36:25.303] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:23:0)
[12:36:25.303] Timer tick, asking Buildbucket for the build status
[12:36:27.509] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:36:27.509] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:24:0) after 1m0s
[12:37:27.570] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:24:0)
[12:37:27.570] Timer tick, asking Buildbucket for the build status
[12:37:27.716] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:37:27.716] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:25:0) after 1m0s
[12:38:27.721] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:25:0)
[12:38:27.721] Timer tick, asking Buildbucket for the build status
[12:38:28.023] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:38:28.023] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:26:0) after 1m0s
[12:39:28.109] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:26:0)
[12:39:28.109] Timer tick, asking Buildbucket for the build status
[12:39:29.797] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:39:29.797] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:27:0) after 1m0s
[12:40:29.823] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:27:0)
[12:40:29.823] Timer tick, asking Buildbucket for the build status
[12:40:30.014] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:40:30.014] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:28:0) after 1m0s
[12:41:30.074] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:28:0)
[12:41:30.074] Timer tick, asking Buildbucket for the build status
[12:41:30.147] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:41:30.147] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:29:0) after 1m0s
[12:42:30.274] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:29:0)
[12:42:30.274] Timer tick, asking Buildbucket for the build status
[12:42:30.367] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:42:30.367] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:30:0) after 1m0s
[12:43:30.419] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:30:0)
[12:43:30.419] Timer tick, asking Buildbucket for the build status
[12:43:30.495] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:43:30.495] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:31:0) after 1m0s
[12:44:30.492] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:31:0)
[12:44:30.492] Timer tick, asking Buildbucket for the build status
[12:44:31.370] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:44:31.370] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:32:0) after 1m0s
[12:45:31.429] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:32:0)
[12:45:31.429] Timer tick, asking Buildbucket for the build status
[12:45:31.655] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:45:31.655] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:33:0) after 1m0s
[12:46:31.674] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:33:0)
[12:46:31.674] Timer tick, asking Buildbucket for the build status
[12:46:31.794] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:46:31.794] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:34:0) after 1m0s
[12:47:31.815] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:34:0)
[12:47:31.815] Timer tick, asking Buildbucket for the build status
[12:47:31.891] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:47:31.891] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:35:0) after 1m0s
[12:48:31.920] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:35:0)
[12:48:31.920] Timer tick, asking Buildbucket for the build status
[12:48:31.988] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:48:31.988] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:36:0) after 1m0s
[12:49:31.997] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:36:0)
[12:49:31.997] Timer tick, asking Buildbucket for the build status
[12:49:42.372] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:49:42.372] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:37:0) after 1m0s
[12:50:42.480] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:37:0)
[12:50:42.480] Timer tick, asking Buildbucket for the build status
[12:50:42.689] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:50:42.689] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:38:0) after 1m0s
[12:51:42.721] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:38:0)
[12:51:42.721] Timer tick, asking Buildbucket for the build status
[12:51:42.862] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:51:42.862] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:39:0) after 1m0s
[12:52:42.925] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:39:0)
[12:52:42.925] Timer tick, asking Buildbucket for the build status
[12:52:43.134] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:52:43.134] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:40:0) after 1m0s
[12:53:43.189] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:40:0)
[12:53:43.189] Timer tick, asking Buildbucket for the build status
[12:53:45.445] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:53:45.445] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:41:0) after 1m0s
[12:54:45.517] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:41:0)
[12:54:45.517] Timer tick, asking Buildbucket for the build status
[12:54:45.603] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:54:45.603] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:42:0) after 1m0s
[12:55:45.650] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:42:0)
[12:55:45.650] Timer tick, asking Buildbucket for the build status
[12:55:45.781] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:55:45.781] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:43:0) after 1m0s
[12:56:45.836] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:43:0)
[12:56:45.836] Timer tick, asking Buildbucket for the build status
[12:56:46.037] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:56:46.037] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:44:0) after 1m0s
[12:57:46.409] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:44:0)
[12:57:46.409] Timer tick, asking Buildbucket for the build status
[12:57:46.498] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:57:46.498] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:45:0) after 1m0s
[12:58:46.626] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:45:0)
[12:58:46.626] Timer tick, asking Buildbucket for the build status
[12:58:46.696] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:58:46.696] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:46:0) after 1m0s
[12:59:46.774] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:46:0)
[12:59:46.774] Timer tick, asking Buildbucket for the build status
[12:59:46.904] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:59:46.904] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:47:0) after 1m0s
[13:00:47.045] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:47:0)
[13:00:47.045] Timer tick, asking Buildbucket for the build status
[13:00:47.373] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:00:47.373] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:48:0) after 1m0s
[13:01:47.437] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:48:0)
[13:01:47.437] Timer tick, asking Buildbucket for the build status
[13:01:47.601] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:01:47.601] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:49:0) after 1m0s
[13:02:47.745] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:49:0)
[13:02:47.745] Timer tick, asking Buildbucket for the build status
[13:02:47.832] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:02:47.832] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:50:0) after 1m0s
[13:03:47.995] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:50:0)
[13:03:47.995] Timer tick, asking Buildbucket for the build status
[13:03:48.341] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:03:48.341] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:51:0) after 1m0s
[13:04:48.381] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:51:0)
[13:04:48.381] Timer tick, asking Buildbucket for the build status
[13:04:48.446] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:04:48.446] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:52:0) after 1m0s
[13:05:48.516] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:52:0)
[13:05:48.516] Timer tick, asking Buildbucket for the build status
[13:05:48.942] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:05:48.942] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:53:0) after 1m0s
[13:06:48.950] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:53:0)
[13:06:48.950] Timer tick, asking Buildbucket for the build status
[13:06:49.119] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:06:49.119] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:54:0) after 1m0s
[13:07:49.177] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:54:0)
[13:07:49.177] Timer tick, asking Buildbucket for the build status
[13:07:49.271] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:07:49.271] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:55:0) after 1m0s
[13:08:49.297] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:55:0)
[13:08:49.297] Timer tick, asking Buildbucket for the build status
[13:08:49.732] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:08:49.732] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:56:0) after 1m0s
[13:09:49.807] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:56:0)
[13:09:49.807] Timer tick, asking Buildbucket for the build status
[13:09:50.132] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:09:50.132] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:57:0) after 1m0s
[13:10:50.270] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:57:0)
[13:10:50.270] Timer tick, asking Buildbucket for the build status
[13:10:54.141] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:10:54.141] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:58:0) after 1m0s
[13:11:54.186] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:58:0)
[13:11:54.186] Timer tick, asking Buildbucket for the build status
[13:11:54.284] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:11:54.284] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:59:0) after 1m0s
[13:12:54.308] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:59:0)
[13:12:54.308] Timer tick, asking Buildbucket for the build status
[13:12:54.523] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:12:54.523] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:60:0) after 1m0s
[13:13:54.551] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:60:0)
[13:13:54.551] Timer tick, asking Buildbucket for the build status
[13:13:54.643] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:13:54.643] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:61:0) after 1m0s
[13:14:54.672] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:61:0)
[13:14:54.672] Timer tick, asking Buildbucket for the build status
[13:14:54.804] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:14:54.804] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:62:0) after 1m0s
[13:15:54.869] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:62:0)
[13:15:54.869] Timer tick, asking Buildbucket for the build status
[13:15:58.876] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:15:58.876] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:63:0) after 1m0s
[13:16:59.019] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:63:0)
[13:16:59.019] Timer tick, asking Buildbucket for the build status
[13:16:59.114] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:16:59.114] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:64:0) after 1m0s
[13:17:59.141] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:64:0)
[13:17:59.141] Timer tick, asking Buildbucket for the build status
[13:17:59.241] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:17:59.241] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:65:0) after 1m0s
[13:18:59.329] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:65:0)
[13:18:59.329] Timer tick, asking Buildbucket for the build status
[13:19:00.153] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:19:00.153] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:66:0) after 1m0s
[13:20:00.229] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:66:0)
[13:20:00.229] Timer tick, asking Buildbucket for the build status
[13:20:00.398] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:20:00.398] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:67:0) after 1m0s
[13:21:00.425] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:67:0)
[13:21:00.425] Timer tick, asking Buildbucket for the build status
[13:21:00.587] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:21:00.587] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:68:0) after 1m0s
[13:22:01.726] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:68:0)
[13:22:01.726] Timer tick, asking Buildbucket for the build status
[13:22:01.845] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:22:01.845] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:69:0) after 1m0s
[13:23:01.900] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:69:0)
[13:23:01.900] Timer tick, asking Buildbucket for the build status
[13:23:02.035] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:23:02.035] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:70:0) after 1m0s
[13:24:02.359] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:70:0)
[13:24:02.359] Timer tick, asking Buildbucket for the build status
[13:24:04.203] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:24:04.203] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:71:0) after 1m0s
[13:25:04.234] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:71:0)
[13:25:04.234] Timer tick, asking Buildbucket for the build status
[13:25:04.447] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:25:04.447] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:72:0) after 1m0s
[13:26:04.506] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:72:0)
[13:26:04.506] Timer tick, asking Buildbucket for the build status
[13:26:04.782] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:26:04.782] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:73:0) after 1m0s
[13:27:04.845] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:73:0)
[13:27:04.845] Timer tick, asking Buildbucket for the build status
[13:27:04.925] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:27:04.925] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:74:0) after 1m0s
[13:28:04.951] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:74:0)
[13:28:04.951] Timer tick, asking Buildbucket for the build status
[13:28:05.022] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:28:05.022] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:75:0) after 1m0s
[13:29:05.041] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:75:0)
[13:29:05.041] Timer tick, asking Buildbucket for the build status
[13:29:05.365] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:29:05.365] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:76:0) after 1m0s
[13:30:05.444] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:76:0)
[13:30:05.444] Timer tick, asking Buildbucket for the build status
[13:30:05.556] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:30:05.556] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:77:0) after 1m0s
[13:31:05.599] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:77:0)
[13:31:05.599] Timer tick, asking Buildbucket for the build status
[13:31:05.707] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:31:05.707] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:78:0) after 1m0s
[13:32:05.735] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:78:0)
[13:32:05.735] Timer tick, asking Buildbucket for the build status
[13:32:05.909] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:32:05.909] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:79:0) after 1m0s
[13:33:05.963] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:79:0)
[13:33:05.963] Timer tick, asking Buildbucket for the build status
[13:33:06.107] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:33:06.107] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:80:0) after 1m0s
[13:34:06.130] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:80:0)
[13:34:06.131] Timer tick, asking Buildbucket for the build status
[13:34:06.519] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:34:06.519] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:81:0) after 1m0s
[13:35:06.512] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:81:0)
[13:35:06.512] Timer tick, asking Buildbucket for the build status
[13:35:07.157] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:35:07.157] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:82:0) after 1m0s
[13:36:07.205] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:82:0)
[13:36:07.205] Timer tick, asking Buildbucket for the build status
[13:36:07.317] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:36:07.317] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:83:0) after 1m0s
[13:37:07.341] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:83:0)
[13:37:07.341] Timer tick, asking Buildbucket for the build status
[13:37:07.707] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:37:07.707] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:84:0) after 1m0s
[13:38:07.730] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:84:0)
[13:38:07.730] Timer tick, asking Buildbucket for the build status
[13:38:07.923] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:38:07.923] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:85:0) after 1m0s
[13:39:07.974] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:85:0)
[13:39:07.974] Timer tick, asking Buildbucket for the build status
[13:39:08.068] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:39:08.068] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:86:0) after 1m0s
[13:40:08.187] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:86:0)
[13:40:08.187] Timer tick, asking Buildbucket for the build status
[13:40:08.396] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:40:08.396] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:87:0) after 1m0s
[13:41:08.410] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:87:0)
[13:41:08.410] Timer tick, asking Buildbucket for the build status
[13:41:08.560] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:41:08.560] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:88:0) after 1m0s
[13:42:08.590] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:88:0)
[13:42:08.590] Timer tick, asking Buildbucket for the build status
[13:42:09.006] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:42:09.006] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:89:0) after 1m0s
[13:43:09.122] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:89:0)
[13:43:09.122] Timer tick, asking Buildbucket for the build status
[13:43:09.293] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:43:09.293] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:90:0) after 1m0s
[13:44:09.372] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:90:0)
[13:44:09.372] Timer tick, asking Buildbucket for the build status
[13:44:09.441] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:44:09.441] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:91:0) after 1m0s
[13:45:09.459] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:91:0)
[13:45:09.460] Timer tick, asking Buildbucket for the build status
[13:45:12.131] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:45:12.131] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:92:0) after 1m0s
[13:46:12.176] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:92:0)
[13:46:12.176] Timer tick, asking Buildbucket for the build status
[13:46:12.394] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:46:12.394] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:93:0) after 1m0s
[13:47:12.378] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:93:0)
[13:47:12.378] Timer tick, asking Buildbucket for the build status
[13:47:13.270] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:47:13.270] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:94:0) after 1m0s
[13:48:13.388] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:94:0)
[13:48:13.388] Timer tick, asking Buildbucket for the build status
[13:48:14.270] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:48:14.270] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:95:0) after 1m0s
[13:49:14.333] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:95:0)
[13:49:14.333] Timer tick, asking Buildbucket for the build status
[13:49:16.677] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:49:16.677] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:96:0) after 1m0s
[13:50:16.736] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:96:0)
[13:50:16.736] Timer tick, asking Buildbucket for the build status
[13:50:16.798] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:50:16.798] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:97:0) after 1m0s
[13:51:16.886] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:97:0)
[13:51:16.886] Timer tick, asking Buildbucket for the build status
[13:51:17.025] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:51:17.025] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:98:0) after 1m0s
[13:52:17.075] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:98:0)
[13:52:17.075] Timer tick, asking Buildbucket for the build status
[13:52:17.186] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:52:17.186] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:99:0) after 1m0s
[13:53:17.242] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:99:0)
[13:53:17.242] Timer tick, asking Buildbucket for the build status
[13:53:17.324] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:53:17.324] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:100:0) after 1m0s
[13:54:17.356] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:100:0)
[13:54:17.356] Timer tick, asking Buildbucket for the build status
[13:54:17.436] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:54:17.436] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:101:0) after 1m0s
[13:55:17.452] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:101:0)
[13:55:17.452] Timer tick, asking Buildbucket for the build status
[13:55:18.047] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:55:18.047] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:102:0) after 1m0s
[13:56:18.081] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:102:0)
[13:56:18.081] Timer tick, asking Buildbucket for the build status
[13:56:18.185] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:56:18.185] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:103:0) after 1m0s
[13:57:18.361] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:103:0)
[13:57:18.361] Timer tick, asking Buildbucket for the build status
[13:57:18.443] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:57:18.443] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:104:0) after 1m0s
[13:58:18.563] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:104:0)
[13:58:18.563] Timer tick, asking Buildbucket for the build status
[13:58:18.702] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:58:18.702] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:105:0) after 1m0s
[13:59:18.762] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:105:0)
[13:59:18.762] Timer tick, asking Buildbucket for the build status
[13:59:18.841] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:59:18.841] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:106:0) after 1m0s
[14:00:18.953] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:106:0)
[14:00:18.953] Timer tick, asking Buildbucket for the build status
[14:00:19.044] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:00:19.044] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:107:0) after 1m0s
[14:01:19.178] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:107:0)
[14:01:19.178] Timer tick, asking Buildbucket for the build status
[14:01:19.311] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:01:19.312] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:108:0) after 1m0s
[14:02:19.415] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:108:0)
[14:02:19.415] Timer tick, asking Buildbucket for the build status
[14:02:20.080] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:02:20.080] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:109:0) after 1m0s
[14:03:20.189] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:109:0)
[14:03:20.189] Timer tick, asking Buildbucket for the build status
[14:03:20.256] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:03:20.256] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:110:0) after 1m0s
[14:04:21.031] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:110:0)
[14:04:21.031] Timer tick, asking Buildbucket for the build status
[14:04:21.315] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:04:21.315] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:111:0) after 1m0s
[14:05:22.021] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:111:0)
[14:05:22.021] Timer tick, asking Buildbucket for the build status
[14:05:22.087] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:05:22.087] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:112:0) after 1m0s
[14:06:22.298] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:112:0)
[14:06:22.298] Timer tick, asking Buildbucket for the build status
[14:06:22.408] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:06:22.408] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:113:0) after 1m0s
[14:07:22.440] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:113:0)
[14:07:22.441] Timer tick, asking Buildbucket for the build status
[14:07:22.508] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:07:22.508] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:114:0) after 1m0s
[14:08:22.608] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:114:0)
[14:08:22.608] Timer tick, asking Buildbucket for the build status
[14:08:22.753] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:08:22.753] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:115:0) after 1m0s
[14:09:23.616] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:115:0)
[14:09:23.616] Timer tick, asking Buildbucket for the build status
[14:09:23.735] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:09:23.735] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:116:0) after 1m0s
[14:10:24.285] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:116:0)
[14:10:24.285] Timer tick, asking Buildbucket for the build status
[14:10:24.356] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:10:24.356] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:117:0) after 1m0s
[14:11:25.378] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:117:0)
[14:11:25.378] Timer tick, asking Buildbucket for the build status
[14:11:25.838] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:11:25.838] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:118:0) after 1m0s
[14:12:27.918] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:118:0)
[14:12:27.918] Timer tick, asking Buildbucket for the build status
[14:12:28.012] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:12:28.012] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:119:0) after 1m0s
[14:13:28.305] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:119:0)
[14:13:28.305] Timer tick, asking Buildbucket for the build status
[14:13:28.522] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:13:28.522] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:120:0) after 1m0s
[14:14:28.605] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:120:0)
[14:14:28.605] Timer tick, asking Buildbucket for the build status
[14:14:28.807] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:14:28.807] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:121:0) after 1m0s
[14:15:28.928] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:121:0)
[14:15:28.928] Timer tick, asking Buildbucket for the build status
[14:15:29.058] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:15:29.058] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:122:0) after 1m0s
[14:16:29.104] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:122:0)
[14:16:29.104] Timer tick, asking Buildbucket for the build status
[14:16:29.355] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:16:29.355] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:123:0) after 1m0s
[14:17:29.494] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:123:0)
[14:17:29.494] Timer tick, asking Buildbucket for the build status
[14:17:29.568] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:17:29.569] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:124:0) after 1m0s
[14:18:29.659] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:124:0)
[14:18:29.659] Timer tick, asking Buildbucket for the build status
[14:18:29.912] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:18:29.912] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:125:0) after 1m0s
[14:19:29.964] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:125:0)
[14:19:29.964] Timer tick, asking Buildbucket for the build status
[14:19:30.054] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:19:30.054] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:126:0) after 1m0s
[14:20:30.076] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:126:0)
[14:20:30.076] Timer tick, asking Buildbucket for the build status
[14:20:30.315] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:20:30.315] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:127:0) after 1m0s
[14:21:30.461] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:127:0)
[14:21:30.461] Timer tick, asking Buildbucket for the build status
[14:21:30.539] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:21:30.539] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:128:0) after 1m0s
[14:22:31.993] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:128:0)
[14:22:31.993] Timer tick, asking Buildbucket for the build status
[14:22:32.308] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:22:32.308] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:129:0) after 1m0s
[14:23:32.840] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:129:0)
[14:23:32.840] Timer tick, asking Buildbucket for the build status
[14:23:39.500] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:23:39.500] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:130:0) after 1m0s
[14:24:39.527] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:130:0)
[14:24:39.527] Timer tick, asking Buildbucket for the build status
[14:24:39.689] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:24:39.689] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:131:0) after 1m0s
[14:25:39.739] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:131:0)
[14:25:39.739] Timer tick, asking Buildbucket for the build status
[14:25:39.856] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:25:39.856] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:132:0) after 1m0s
[14:26:39.958] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:132:0)
[14:26:39.958] Timer tick, asking Buildbucket for the build status
[14:26:40.084] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:26:40.085] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:133:0) after 1m0s
[14:27:40.171] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:133:0)
[14:27:40.171] Timer tick, asking Buildbucket for the build status
[14:27:40.458] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:27:40.458] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:134:0) after 1m0s
[14:28:40.556] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:134:0)
[14:28:40.556] Timer tick, asking Buildbucket for the build status
[14:28:40.625] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:28:40.625] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:135:0) after 1m0s
[14:29:40.650] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:135:0)
[14:29:40.650] Timer tick, asking Buildbucket for the build status
[14:29:40.729] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:29:40.729] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:136:0) after 1m0s
[14:30:40.821] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:136:0)
[14:30:40.821] Timer tick, asking Buildbucket for the build status
[14:30:42.521] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:30:42.521] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:137:0) after 1m0s
[14:31:42.628] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:137:0)
[14:31:42.628] Timer tick, asking Buildbucket for the build status
[14:31:42.840] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:31:42.840] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:138:0) after 1m0s
[14:32:43.107] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:138:0)
[14:32:43.107] Timer tick, asking Buildbucket for the build status
[14:32:44.059] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:32:44.059] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:139:0) after 1m0s
[14:33:44.143] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:139:0)
[14:33:44.143] Timer tick, asking Buildbucket for the build status
[14:33:44.309] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:33:44.309] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:140:0) after 1m0s
[14:34:44.374] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:140:0)
[14:34:44.374] Timer tick, asking Buildbucket for the build status
[14:34:45.383] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:34:45.384] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:141:0) after 1m0s
[14:35:45.519] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:141:0)
[14:35:45.519] Timer tick, asking Buildbucket for the build status
[14:35:45.630] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:35:45.630] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:142:0) after 1m0s
[14:36:45.790] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:142:0)
[14:36:45.790] Timer tick, asking Buildbucket for the build status
[14:36:45.882] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:36:45.882] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:143:0) after 1m0s
[14:37:45.932] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:143:0)
[14:37:45.932] Timer tick, asking Buildbucket for the build status
[14:37:46.140] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:37:46.140] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:144:0) after 1m0s
[14:38:46.194] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:144:0)
[14:38:46.194] Timer tick, asking Buildbucket for the build status
[14:38:46.352] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:38:46.352] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:145:0) after 1m0s
[14:39:46.396] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:145:0)
[14:39:46.396] Timer tick, asking Buildbucket for the build status
[14:39:46.451] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:39:46.451] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:146:0) after 1m0s
[14:40:46.523] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:146:0)
[14:40:46.523] Timer tick, asking Buildbucket for the build status
[14:40:46.694] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:40:46.694] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:147:0) after 1m0s
[14:41:46.693] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:147:0)
[14:41:46.693] Timer tick, asking Buildbucket for the build status
[14:41:46.786] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:41:46.786] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:148:0) after 1m0s
[14:42:46.814] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:148:0)
[14:42:46.814] Timer tick, asking Buildbucket for the build status
[14:42:46.891] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:42:46.891] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:149:0) after 1m0s
[14:43:46.909] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:149:0)
[14:43:46.909] Timer tick, asking Buildbucket for the build status
[14:43:47.552] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:43:47.552] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:150:0) after 1m0s
[14:44:47.574] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:150:0)
[14:44:47.574] Timer tick, asking Buildbucket for the build status
[14:44:47.820] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:44:47.820] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:151:0) after 1m0s
[14:45:47.823] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:151:0)
[14:45:47.823] Timer tick, asking Buildbucket for the build status
[14:45:47.945] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:45:47.945] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:152:0) after 1m0s
[14:46:47.999] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:152:0)
[14:46:47.999] Timer tick, asking Buildbucket for the build status
[14:46:48.108] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:46:48.108] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:153:0) after 1m0s
[14:47:48.159] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:153:0)
[14:47:48.159] Timer tick, asking Buildbucket for the build status
[14:47:49.271] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:47:49.271] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:154:0) after 1m0s
[14:48:49.307] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:154:0)
[14:48:49.307] Timer tick, asking Buildbucket for the build status
[14:48:49.601] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:48:49.601] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:155:0) after 1m0s
[14:49:49.628] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:155:0)
[14:49:49.628] Timer tick, asking Buildbucket for the build status
[14:49:49.725] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:49:49.725] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:156:0) after 1m0s
[14:50:49.765] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:156:0)
[14:50:49.765] Timer tick, asking Buildbucket for the build status
[14:50:50.338] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:50:50.338] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:157:0) after 1m0s
[14:51:50.382] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:157:0)
[14:51:50.382] Timer tick, asking Buildbucket for the build status
[14:51:50.929] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:51:50.929] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:158:0) after 1m0s
[14:52:50.979] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:158:0)
[14:52:50.979] Timer tick, asking Buildbucket for the build status
[14:52:51.242] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:52:51.242] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:159:0) after 1m0s
[14:53:51.273] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:159:0)
[14:53:51.273] Timer tick, asking Buildbucket for the build status
[14:53:51.547] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:53:51.547] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:160:0) after 1m0s
[14:54:51.557] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:160:0)
[14:54:51.557] Timer tick, asking Buildbucket for the build status
[14:54:52.839] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:54:52.839] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:161:0) after 1m0s
[14:55:53.006] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:161:0)
[14:55:53.006] Timer tick, asking Buildbucket for the build status
[14:55:53.152] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:55:53.152] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:162:0) after 1m0s
[14:56:53.183] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:162:0)
[14:56:53.183] Timer tick, asking Buildbucket for the build status
[14:56:53.259] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:56:53.259] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:163:0) after 1m0s
[14:57:53.287] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:163:0)
[14:57:53.287] Timer tick, asking Buildbucket for the build status
[14:57:53.500] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:57:53.500] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:164:0) after 1m0s
[14:58:53.585] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:164:0)
[14:58:53.585] Timer tick, asking Buildbucket for the build status
[14:58:53.980] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:58:53.980] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:165:0) after 1m0s
[14:59:54.004] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:165:0)
[14:59:54.004] Timer tick, asking Buildbucket for the build status
[14:59:54.294] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:59:54.294] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:166:0) after 1m0s
[15:00:54.387] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:166:0)
[15:00:54.387] Timer tick, asking Buildbucket for the build status
[15:00:54.516] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:00:54.516] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:167:0) after 1m0s
[15:01:54.679] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:167:0)
[15:01:54.679] Timer tick, asking Buildbucket for the build status
[15:01:55.102] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:01:55.102] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:168:0) after 1m0s
[15:02:55.178] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:168:0)
[15:02:55.178] Timer tick, asking Buildbucket for the build status
[15:02:55.852] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:02:55.852] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:169:0) after 1m0s
[15:03:55.902] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:169:0)
[15:03:55.902] Timer tick, asking Buildbucket for the build status
[15:03:58.795] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:03:58.795] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:170:0) after 1m0s
[15:04:58.910] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:170:0)
[15:04:58.910] Timer tick, asking Buildbucket for the build status
[15:04:59.066] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:04:59.066] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:171:0) after 1m0s
[15:05:59.141] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:171:0)
[15:05:59.141] Timer tick, asking Buildbucket for the build status
[15:05:59.578] Build 8867189106240989424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:05:59.578] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:172:0) after 1m0s
[15:06:59.605] Handling timer "check-buildbucket-build-status" (chromium/win-official:9032619169686305808:172:0)
[15:06:59.605] Timer tick, asking Buildbucket for the build status
[15:07:00.437] Build 8867189106240989424: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[15:07:00.437] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1601996786561140",
"created_by": "project:chromium",
"created_ts": "1601986512868750",
"id": "8867189106240989424",
"parameters_json": "{\"builder_name\": \"win-official\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"790c32c397ee5aa960a8bab673045be3838a60a0\"}}",
"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\": \"790c32c397ee5aa960a8bab673045be3838a60a0\", \"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-2-xqx6\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium\", \"buildername\": \"win-official\", \"buildnumber\": 751, \"got_angle_revision\": \"f6e983b87ff4d856af26cf5a9cb6e6a1f8ddb9d9\", \"got_dawn_revision\": \"db2c2dd9b9a2d94c1ac8737cae1924314f11960a\", \"got_nacl_revision\": \"69a0d6e8affc94187af10e0673592d1b238c6eb0\", \"got_revision\": \"790c32c397ee5aa960a8bab673045be3838a60a0\", \"got_revision_cp\": \"refs/heads/master@{#814177}\", \"got_swarming_client_revision\": \"44c13d73156581ea09b9389001e58c23a4b8d70a\", \"got_swiftshader_revision\": \"afe6ca45b6da79f52d02b76bce03fc72cc322920\", \"got_v8_revision\": \"a95acb3a7489a28bceb80929cfa2c8f1851b8eac\", \"got_v8_revision_cp\": \"refs/heads/8.8.23@{#1}\", \"got_webrtc_revision\": \"eacbd972ab7e85e9d61851ced57aba1eb194de3d\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#32316}\", \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"790c32c397ee5aa960a8bab673045be3838a60a0\"}, \"swarming\": {\"bot_dimensions\": {\"builder\": [\"win-archive-dbg\", \"win-archive-rel\", \"win-official\", \"win32-archive-dbg\", \"win32-archive-rel\", \"win32-official\"], \"caches\": [\"builder_9b3ebe5fd1c5be87380c40d216747346a59b28cf26de183f0e8e2b32e944d3c8_v2\", \"git\"], \"cores\": [\"32\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"win-dbg-2-xqx6\"], \"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\": [\"5570-fa4adf0\"], \"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": "1601986539131427",
"status": "COMPLETED",
"status_changed_ts": "1601996786906225",
"tags": [
"build_address:luci.chromium.ci/win-official/751",
"builder:win-official",
"buildset:commit/git/790c32c397ee5aa960a8bab673045be3838a60a0",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/790c32c397ee5aa960a8bab673045be3838a60a0",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9032619169686305808",
"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/8867189106240989424/+/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:4f16a7ea61a1b310",
"user_agent:luci-scheduler"
],
"updated_ts": "1601996786910811",
"url": "https://ci.chromium.org/b/8867189106240989424",
"utcnow_ts": "1601996820309224"
}
}
[15:07:00.437] Invocation finished in 2h51m50.237900992s with status SUCCEEDED