[17:34:30.599] New invocation is queued and will start shortly
[17:34:31.799] Starting the invocation (attempt 1)
[17:34:31.873] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[17:34:31.874] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[17:34:31.874] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9059687571524564720",
"parameters_json": "{\"builder_name\":\"Windows deterministic\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"3c29c8546feda9e6a2adf9233bd91e781f732da2\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:Windows deterministic",
"scheduler_invocation_id:9059687571524564720",
"scheduler_job_id:chromium/Windows deterministic",
"user_agent:luci-scheduler",
"buildset:commit/git/3c29c8546feda9e6a2adf9233bd91e781f732da2",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/3c29c8546feda9e6a2adf9233bd91e781f732da2",
"gitiles_ref:refs/heads/master"
]
}
[17:34:34.179] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1576172072462475",
"id": "8894257508904337264",
"parameters_json": "{\"builder_name\": \"Windows deterministic\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"3c29c8546feda9e6a2adf9233bd91e781f732da2\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1576172073765276",
"tags": [
"build_address:luci.chromium.ci/Windows deterministic/15441",
"builder:Windows deterministic",
"buildset:commit/git/3c29c8546feda9e6a2adf9233bd91e781f732da2",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/3c29c8546feda9e6a2adf9233bd91e781f732da2",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9059687571524564720",
"scheduler_job_id:chromium/Windows deterministic",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8894257508904337264/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:recipe_name:swarming/deterministic_build",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:",
"user_agent:luci-scheduler"
],
"updated_ts": "1576172073765422",
"url": "https://ci.chromium.org/b/8894257508904337264",
"utcnow_ts": "1576172074143879"
}
}
[17:34:34.179] Task URL: https://ci.chromium.org/b/8894257508904337264
[17:34:34.179] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:2:0) after 1m0s
[17:35:34.323] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:2:0)
[17:35:34.323] Timer tick, asking Buildbucket for the build status
[17:35:34.930] Build 8894257508904337264: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[17:35:34.930] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:3:0) after 1m0s
[17:36:35.008] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:3:0)
[17:36:35.008] Timer tick, asking Buildbucket for the build status
[17:36:35.471] Build 8894257508904337264: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[17:36:35.472] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:4:0) after 1m0s
[17:37:35.463] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:4:0)
[17:37:35.463] Timer tick, asking Buildbucket for the build status
[17:37:35.730] Build 8894257508904337264: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[17:37:35.730] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:5:0) after 1m0s
[17:38:35.810] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:5:0)
[17:38:35.810] Timer tick, asking Buildbucket for the build status
[17:38:35.967] Build 8894257508904337264: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[17:38:35.967] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:6:0) after 1m0s
[17:39:36.156] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:6:0)
[17:39:36.156] Timer tick, asking Buildbucket for the build status
[17:39:37.755] Build 8894257508904337264: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[17:39:37.755] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:7:0) after 1m0s
[17:40:37.853] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:7:0)
[17:40:37.853] Timer tick, asking Buildbucket for the build status
[17:40:38.033] Build 8894257508904337264: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[17:40:38.033] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:8:0) after 1m0s
[17:41:38.054] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:8:0)
[17:41:38.054] Timer tick, asking Buildbucket for the build status
[17:41:38.231] Build 8894257508904337264: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[17:41:38.231] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:9:0) after 1m0s
[17:42:38.294] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:9:0)
[17:42:38.294] Timer tick, asking Buildbucket for the build status
[17:42:38.609] Build 8894257508904337264: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[17:42:38.609] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:10:0) after 1m0s
[17:43:38.687] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:10:0)
[17:43:38.687] Timer tick, asking Buildbucket for the build status
[17:43:39.232] Build 8894257508904337264: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[17:43:39.232] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:11:0) after 1m0s
[17:44:39.271] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:11:0)
[17:44:39.271] Timer tick, asking Buildbucket for the build status
[17:44:39.469] Build 8894257508904337264: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[17:44:39.469] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:12:0) after 1m0s
[17:45:04.641] Received PubSub notification, asking Buildbucket for the build status
[17:45:05.495] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:45:39.508] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:12:0)
[17:45:39.508] Timer tick, asking Buildbucket for the build status
[17:45:39.663] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:45:39.663] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:14:0) after 1m0s
[17:46:39.659] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:14:0)
[17:46:39.659] Timer tick, asking Buildbucket for the build status
[17:46:39.821] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:46:39.821] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:15:0) after 1m0s
[17:47:39.853] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:15:0)
[17:47:39.853] Timer tick, asking Buildbucket for the build status
[17:47:40.373] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:47:40.373] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:16:0) after 1m0s
[17:48:40.430] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:16:0)
[17:48:40.430] Timer tick, asking Buildbucket for the build status
[17:48:40.667] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:48:40.667] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:17:0) after 1m0s
[17:49:40.762] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:17:0)
[17:49:40.762] Timer tick, asking Buildbucket for the build status
[17:49:41.176] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:49:41.176] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:18:0) after 1m0s
[17:50:41.308] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:18:0)
[17:50:41.309] Timer tick, asking Buildbucket for the build status
[17:50:41.598] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:50:41.598] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:19:0) after 1m0s
[17:51:41.779] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:19:0)
[17:51:41.779] Timer tick, asking Buildbucket for the build status
[17:51:42.275] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:51:42.275] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:20:0) after 1m0s
[17:52:42.383] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:20:0)
[17:52:42.383] Timer tick, asking Buildbucket for the build status
[17:52:43.012] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:52:43.012] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:21:0) after 1m0s
[17:53:43.121] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:21:0)
[17:53:43.121] Timer tick, asking Buildbucket for the build status
[17:53:43.434] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:53:43.434] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:22:0) after 1m0s
[17:54:43.567] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:22:0)
[17:54:43.567] Timer tick, asking Buildbucket for the build status
[17:54:43.925] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:54:43.925] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:23:0) after 1m0s
[17:55:44.291] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:23:0)
[17:55:44.291] Timer tick, asking Buildbucket for the build status
[17:55:44.853] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:55:44.853] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:24:0) after 1m0s
[17:56:45.003] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:24:0)
[17:56:45.003] Timer tick, asking Buildbucket for the build status
[17:56:46.860] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:56:46.860] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:25:0) after 1m0s
[17:57:46.919] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:25:0)
[17:57:46.919] Timer tick, asking Buildbucket for the build status
[17:57:47.346] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:57:47.346] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:26:0) after 1m0s
[17:58:47.440] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:26:0)
[17:58:47.440] Timer tick, asking Buildbucket for the build status
[17:58:48.027] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:58:48.027] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:27:0) after 1m0s
[17:59:48.112] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:27:0)
[17:59:48.112] Timer tick, asking Buildbucket for the build status
[17:59:48.434] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:59:48.434] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:28:0) after 1m0s
[18:00:48.498] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:28:0)
[18:00:48.498] Timer tick, asking Buildbucket for the build status
[18:00:48.696] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:00:48.696] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:29:0) after 1m0s
[18:01:48.761] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:29:0)
[18:01:48.761] Timer tick, asking Buildbucket for the build status
[18:01:48.917] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:01:48.917] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:30:0) after 1m0s
[18:02:49.402] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:30:0)
[18:02:49.402] Timer tick, asking Buildbucket for the build status
[18:02:50.863] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:02:50.863] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:31:0) after 1m0s
[18:03:51.408] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:31:0)
[18:03:51.408] Timer tick, asking Buildbucket for the build status
[18:03:51.626] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:03:51.626] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:32:0) after 1m0s
[18:04:51.666] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:32:0)
[18:04:51.666] Timer tick, asking Buildbucket for the build status
[18:04:51.825] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:04:51.825] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:33:0) after 1m0s
[18:05:51.890] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:33:0)
[18:05:51.890] Timer tick, asking Buildbucket for the build status
[18:05:52.115] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:05:52.115] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:34:0) after 1m0s
[18:06:52.303] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:34:0)
[18:06:52.303] Timer tick, asking Buildbucket for the build status
[18:06:52.566] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:06:52.566] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:35:0) after 1m0s
[18:07:52.625] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:35:0)
[18:07:52.625] Timer tick, asking Buildbucket for the build status
[18:07:53.047] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:07:53.047] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:36:0) after 1m0s
[18:08:53.222] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:36:0)
[18:08:53.222] Timer tick, asking Buildbucket for the build status
[18:08:53.454] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:08:53.454] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:37:0) after 1m0s
[18:09:53.694] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:37:0)
[18:09:53.694] Timer tick, asking Buildbucket for the build status
[18:09:57.280] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:09:57.280] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:38:0) after 1m0s
[18:10:57.293] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:38:0)
[18:10:57.293] Timer tick, asking Buildbucket for the build status
[18:10:57.635] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:10:57.635] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:39:0) after 1m0s
[18:11:57.795] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:39:0)
[18:11:57.795] Timer tick, asking Buildbucket for the build status
[18:11:58.123] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:11:58.123] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:40:0) after 1m0s
[18:12:58.192] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:40:0)
[18:12:58.192] Timer tick, asking Buildbucket for the build status
[18:12:58.863] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:12:58.863] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:41:0) after 1m0s
[18:13:58.892] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:41:0)
[18:13:58.892] Timer tick, asking Buildbucket for the build status
[18:13:59.117] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:13:59.117] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:42:0) after 1m0s
[18:14:59.800] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:42:0)
[18:14:59.800] Timer tick, asking Buildbucket for the build status
[18:15:01.749] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:15:01.749] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:43:0) after 1m0s
[18:16:01.916] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:43:0)
[18:16:01.916] Timer tick, asking Buildbucket for the build status
[18:16:02.607] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:16:02.607] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:44:0) after 1m0s
[18:17:02.753] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:44:0)
[18:17:02.755] Timer tick, asking Buildbucket for the build status
[18:17:03.345] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:17:03.345] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:45:0) after 1m0s
[18:18:03.407] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:45:0)
[18:18:03.407] Timer tick, asking Buildbucket for the build status
[18:18:03.613] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:18:03.613] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:46:0) after 1m0s
[18:19:03.665] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:46:0)
[18:19:03.665] Timer tick, asking Buildbucket for the build status
[18:19:03.972] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:19:03.972] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:47:0) after 1m0s
[18:20:03.999] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:47:0)
[18:20:03.999] Timer tick, asking Buildbucket for the build status
[18:20:05.305] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:20:05.305] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:48:0) after 1m0s
[18:21:05.332] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:48:0)
[18:21:05.332] Timer tick, asking Buildbucket for the build status
[18:21:05.948] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:21:05.948] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:49:0) after 1m0s
[18:22:06.010] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:49:0)
[18:22:06.010] Timer tick, asking Buildbucket for the build status
[18:22:06.247] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:22:06.248] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:50:0) after 1m0s
[18:23:06.273] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:50:0)
[18:23:06.273] Timer tick, asking Buildbucket for the build status
[18:23:06.542] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:23:06.542] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:51:0) after 1m0s
[18:24:06.589] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:51:0)
[18:24:06.589] Timer tick, asking Buildbucket for the build status
[18:24:08.232] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:24:08.232] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:52:0) after 1m0s
[18:25:08.371] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:52:0)
[18:25:08.371] Timer tick, asking Buildbucket for the build status
[18:25:08.642] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:25:08.642] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:53:0) after 1m0s
[18:26:08.881] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:53:0)
[18:26:08.881] Timer tick, asking Buildbucket for the build status
[18:26:09.079] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:26:09.079] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:54:0) after 1m0s
[18:27:09.282] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:54:0)
[18:27:09.282] Timer tick, asking Buildbucket for the build status
[18:27:10.425] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:27:10.425] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:55:0) after 1m0s
[18:28:10.598] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:55:0)
[18:28:10.598] Timer tick, asking Buildbucket for the build status
[18:28:10.793] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:28:10.793] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:56:0) after 1m0s
[18:29:10.969] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:56:0)
[18:29:10.969] Timer tick, asking Buildbucket for the build status
[18:29:11.335] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:29:11.335] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:57:0) after 1m0s
[18:30:11.458] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:57:0)
[18:30:11.458] Timer tick, asking Buildbucket for the build status
[18:30:12.407] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:30:12.407] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:58:0) after 1m0s
[18:31:12.718] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:58:0)
[18:31:12.718] Timer tick, asking Buildbucket for the build status
[18:31:13.171] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:31:13.171] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:59:0) after 1m0s
[18:32:13.304] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:59:0)
[18:32:13.304] Timer tick, asking Buildbucket for the build status
[18:32:14.009] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:32:14.009] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:60:0) after 1m0s
[18:33:14.635] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:60:0)
[18:33:14.635] Timer tick, asking Buildbucket for the build status
[18:33:14.973] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:33:14.973] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:61:0) after 1m0s
[18:34:15.470] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:61:0)
[18:34:15.470] Timer tick, asking Buildbucket for the build status
[18:34:16.824] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:34:16.824] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:62:0) after 1m0s
[18:35:17.369] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:62:0)
[18:35:17.369] Timer tick, asking Buildbucket for the build status
[18:35:18.437] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:35:18.437] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:63:0) after 1m0s
[18:36:18.491] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:63:0)
[18:36:18.491] Timer tick, asking Buildbucket for the build status
[18:36:18.713] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:36:18.713] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:64:0) after 1m0s
[18:37:18.741] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:64:0)
[18:37:18.741] Timer tick, asking Buildbucket for the build status
[18:37:18.915] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:37:18.915] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:65:0) after 1m0s
[18:38:19.406] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:65:0)
[18:38:19.406] Timer tick, asking Buildbucket for the build status
[18:38:23.922] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:38:23.922] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:66:0) after 1m0s
[18:39:24.018] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:66:0)
[18:39:24.018] Timer tick, asking Buildbucket for the build status
[18:39:24.337] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:39:24.337] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:67:0) after 1m0s
[18:40:24.540] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:67:0)
[18:40:24.540] Timer tick, asking Buildbucket for the build status
[18:40:24.994] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:40:24.994] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:68:0) after 1m0s
[18:41:25.389] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:68:0)
[18:41:25.389] Timer tick, asking Buildbucket for the build status
[18:41:28.480] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:41:28.480] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:69:0) after 1m0s
[18:42:28.555] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:69:0)
[18:42:28.555] Timer tick, asking Buildbucket for the build status
[18:42:29.909] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:42:29.909] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:70:0) after 1m0s
[18:43:30.008] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:70:0)
[18:43:30.008] Timer tick, asking Buildbucket for the build status
[18:43:31.334] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:43:31.334] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:71:0) after 1m0s
[18:44:31.425] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:71:0)
[18:44:31.425] Timer tick, asking Buildbucket for the build status
[18:44:31.605] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:44:31.605] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:72:0) after 1m0s
[18:45:31.773] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:72:0)
[18:45:31.773] Timer tick, asking Buildbucket for the build status
[18:45:35.285] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:45:35.285] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:73:0) after 1m0s
[18:46:35.390] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:73:0)
[18:46:35.390] Timer tick, asking Buildbucket for the build status
[18:46:36.588] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:46:36.588] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:74:0) after 1m0s
[18:47:37.054] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:74:0)
[18:47:37.054] Timer tick, asking Buildbucket for the build status
[18:47:38.805] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:47:38.805] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:75:0) after 1m0s
[18:48:38.939] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:75:0)
[18:48:38.939] Timer tick, asking Buildbucket for the build status
[18:48:41.807] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:48:41.807] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:76:0) after 1m0s
[18:49:41.995] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:76:0)
[18:49:41.995] Timer tick, asking Buildbucket for the build status
[18:49:42.431] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:49:42.431] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:77:0) after 1m0s
[18:50:42.524] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:77:0)
[18:50:42.524] Timer tick, asking Buildbucket for the build status
[18:50:42.694] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:50:42.694] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:78:0) after 1m0s
[18:51:42.800] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:78:0)
[18:51:42.800] Timer tick, asking Buildbucket for the build status
[18:51:43.211] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:51:43.211] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:79:0) after 1m0s
[18:52:43.345] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:79:0)
[18:52:43.345] Timer tick, asking Buildbucket for the build status
[18:52:43.503] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:52:43.503] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:80:0) after 1m0s
[18:53:43.647] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:80:0)
[18:53:43.647] Timer tick, asking Buildbucket for the build status
[18:53:43.885] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:53:43.885] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:81:0) after 1m0s
[18:54:44.104] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:81:0)
[18:54:44.104] Timer tick, asking Buildbucket for the build status
[18:54:44.361] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:54:44.361] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:82:0) after 1m0s
[18:55:44.476] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:82:0)
[18:55:44.476] Timer tick, asking Buildbucket for the build status
[18:55:45.131] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:55:45.131] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:83:0) after 1m0s
[18:56:45.282] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:83:0)
[18:56:45.282] Timer tick, asking Buildbucket for the build status
[18:56:45.530] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:56:45.530] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:84:0) after 1m0s
[18:57:45.576] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:84:0)
[18:57:45.576] Timer tick, asking Buildbucket for the build status
[18:57:46.260] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:57:46.260] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:85:0) after 1m0s
[18:58:46.402] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:85:0)
[18:58:46.402] Timer tick, asking Buildbucket for the build status
[18:58:46.952] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:58:46.952] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:86:0) after 1m0s
[18:59:46.991] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:86:0)
[18:59:46.991] Timer tick, asking Buildbucket for the build status
[18:59:48.355] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:59:48.355] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:87:0) after 1m0s
[19:00:48.415] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:87:0)
[19:00:48.415] Timer tick, asking Buildbucket for the build status
[19:00:49.024] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:00:49.024] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:88:0) after 1m0s
[19:01:49.084] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:88:0)
[19:01:49.084] Timer tick, asking Buildbucket for the build status
[19:01:49.189] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:01:49.189] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:89:0) after 1m0s
[19:02:49.498] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:89:0)
[19:02:49.498] Timer tick, asking Buildbucket for the build status
[19:02:49.885] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:02:49.885] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:90:0) after 1m0s
[19:03:50.010] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:90:0)
[19:03:50.010] Timer tick, asking Buildbucket for the build status
[19:03:50.311] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:03:50.311] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:91:0) after 1m0s
[19:04:50.415] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:91:0)
[19:04:50.415] Timer tick, asking Buildbucket for the build status
[19:04:51.130] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:04:51.130] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:92:0) after 1m0s
[19:05:51.369] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:92:0)
[19:05:51.369] Timer tick, asking Buildbucket for the build status
[19:05:52.153] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:05:52.153] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:93:0) after 1m0s
[19:06:52.347] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:93:0)
[19:06:52.347] Timer tick, asking Buildbucket for the build status
[19:06:53.151] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:06:53.151] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:94:0) after 1m0s
[19:07:53.314] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:94:0)
[19:07:53.314] Timer tick, asking Buildbucket for the build status
[19:07:53.631] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:07:53.631] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:95:0) after 1m0s
[19:08:53.718] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:95:0)
[19:08:53.718] Timer tick, asking Buildbucket for the build status
[19:08:53.958] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:08:53.958] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:96:0) after 1m0s
[19:09:54.132] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:96:0)
[19:09:54.132] Timer tick, asking Buildbucket for the build status
[19:09:54.404] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:09:54.404] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:97:0) after 1m0s
[19:10:54.487] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:97:0)
[19:10:54.487] Timer tick, asking Buildbucket for the build status
[19:10:54.997] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:10:54.997] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:98:0) after 1m0s
[19:11:55.109] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:98:0)
[19:11:55.109] Timer tick, asking Buildbucket for the build status
[19:11:55.366] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:11:55.366] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:99:0) after 1m0s
[19:12:55.413] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:99:0)
[19:12:55.413] Timer tick, asking Buildbucket for the build status
[19:12:56.049] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:12:56.049] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:100:0) after 1m0s
[19:13:56.160] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:100:0)
[19:13:56.160] Timer tick, asking Buildbucket for the build status
[19:13:56.469] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:13:56.470] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:101:0) after 1m0s
[19:14:56.559] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:101:0)
[19:14:56.559] Timer tick, asking Buildbucket for the build status
[19:14:57.421] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:14:57.421] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:102:0) after 1m0s
[19:15:57.443] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:102:0)
[19:15:57.443] Timer tick, asking Buildbucket for the build status
[19:15:58.238] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:15:58.238] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:103:0) after 1m0s
[19:16:58.285] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:103:0)
[19:16:58.285] Timer tick, asking Buildbucket for the build status
[19:16:59.138] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:16:59.138] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:104:0) after 1m0s
[19:17:59.176] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:104:0)
[19:17:59.176] Timer tick, asking Buildbucket for the build status
[19:18:01.578] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:18:01.578] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:105:0) after 1m0s
[19:19:01.703] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:105:0)
[19:19:01.703] Timer tick, asking Buildbucket for the build status
[19:19:02.152] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:19:02.152] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:106:0) after 1m0s
[19:20:02.263] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:106:0)
[19:20:02.263] Timer tick, asking Buildbucket for the build status
[19:20:02.827] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:20:02.827] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:107:0) after 1m0s
[19:21:02.879] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:107:0)
[19:21:02.879] Timer tick, asking Buildbucket for the build status
[19:21:03.102] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:21:03.102] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:108:0) after 1m0s
[19:22:03.193] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:108:0)
[19:22:03.193] Timer tick, asking Buildbucket for the build status
[19:22:03.551] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:22:03.551] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:109:0) after 1m0s
[19:23:03.679] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:109:0)
[19:23:03.679] Timer tick, asking Buildbucket for the build status
[19:23:04.031] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:23:04.031] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:110:0) after 1m0s
[19:24:04.301] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:110:0)
[19:24:04.301] Timer tick, asking Buildbucket for the build status
[19:24:04.451] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:24:04.451] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:111:0) after 1m0s
[19:25:04.758] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:111:0)
[19:25:04.758] Timer tick, asking Buildbucket for the build status
[19:25:04.993] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:25:04.993] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:112:0) after 1m0s
[19:26:05.221] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:112:0)
[19:26:05.221] Timer tick, asking Buildbucket for the build status
[19:26:05.758] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:26:05.758] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:113:0) after 1m0s
[19:27:05.842] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:113:0)
[19:27:05.842] Timer tick, asking Buildbucket for the build status
[19:27:06.087] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:27:06.087] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:114:0) after 1m0s
[19:28:06.980] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:114:0)
[19:28:06.980] Timer tick, asking Buildbucket for the build status
[19:28:07.538] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:28:07.538] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:115:0) after 1m0s
[19:29:07.679] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:115:0)
[19:29:07.679] Timer tick, asking Buildbucket for the build status
[19:29:07.890] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:29:07.890] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:116:0) after 1m0s
[19:30:07.999] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:116:0)
[19:30:07.999] Timer tick, asking Buildbucket for the build status
[19:30:08.451] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:30:08.451] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:117:0) after 1m0s
[19:31:08.586] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:117:0)
[19:31:08.586] Timer tick, asking Buildbucket for the build status
[19:31:09.718] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:31:09.718] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:118:0) after 1m0s
[19:32:09.840] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:118:0)
[19:32:09.840] Timer tick, asking Buildbucket for the build status
[19:32:10.040] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:32:10.040] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:119:0) after 1m0s
[19:33:10.178] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:119:0)
[19:33:10.178] Timer tick, asking Buildbucket for the build status
[19:33:11.364] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:33:11.365] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:120:0) after 1m0s
[19:34:11.670] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:120:0)
[19:34:11.670] Timer tick, asking Buildbucket for the build status
[19:34:11.992] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:34:11.992] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:121:0) after 1m0s
[19:35:12.070] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:121:0)
[19:35:12.070] Timer tick, asking Buildbucket for the build status
[19:35:12.279] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:35:12.280] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:122:0) after 1m0s
[19:36:12.382] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:122:0)
[19:36:12.382] Timer tick, asking Buildbucket for the build status
[19:36:12.532] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:36:12.532] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:123:0) after 1m0s
[19:37:12.595] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:123:0)
[19:37:12.596] Timer tick, asking Buildbucket for the build status
[19:37:12.780] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:37:12.780] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:124:0) after 1m0s
[19:38:13.052] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:124:0)
[19:38:13.052] Timer tick, asking Buildbucket for the build status
[19:38:13.224] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:38:13.224] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:125:0) after 1m0s
[19:39:13.559] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:125:0)
[19:39:13.559] Timer tick, asking Buildbucket for the build status
[19:39:14.508] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:39:14.508] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:126:0) after 1m0s
[19:40:14.756] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:126:0)
[19:40:14.756] Timer tick, asking Buildbucket for the build status
[19:40:15.200] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:40:15.200] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:127:0) after 1m0s
[19:41:15.294] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:127:0)
[19:41:15.294] Timer tick, asking Buildbucket for the build status
[19:41:15.807] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:41:15.807] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:128:0) after 1m0s
[19:42:15.958] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:128:0)
[19:42:15.958] Timer tick, asking Buildbucket for the build status
[19:42:16.163] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:42:16.163] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:129:0) after 1m0s
[19:43:16.557] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:129:0)
[19:43:16.557] Timer tick, asking Buildbucket for the build status
[19:43:17.287] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:43:17.287] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:130:0) after 1m0s
[19:44:17.458] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:130:0)
[19:44:17.458] Timer tick, asking Buildbucket for the build status
[19:44:17.716] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:44:17.717] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:131:0) after 1m0s
[19:45:17.748] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:131:0)
[19:45:17.748] Timer tick, asking Buildbucket for the build status
[19:45:18.476] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:45:18.476] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:132:0) after 1m0s
[19:46:18.638] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:132:0)
[19:46:18.638] Timer tick, asking Buildbucket for the build status
[19:46:19.532] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:46:19.532] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:133:0) after 1m0s
[19:47:19.726] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:133:0)
[19:47:19.726] Timer tick, asking Buildbucket for the build status
[19:47:21.635] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:47:21.635] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:134:0) after 1m0s
[19:48:21.846] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:134:0)
[19:48:21.846] Timer tick, asking Buildbucket for the build status
[19:48:23.073] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:48:23.073] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:135:0) after 1m0s
[19:49:23.425] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:135:0)
[19:49:23.425] Timer tick, asking Buildbucket for the build status
[19:49:23.943] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:49:23.943] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:136:0) after 1m0s
[19:50:24.027] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:136:0)
[19:50:24.027] Timer tick, asking Buildbucket for the build status
[19:50:24.491] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:50:24.491] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:137:0) after 1m0s
[19:51:24.637] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:137:0)
[19:51:24.637] Timer tick, asking Buildbucket for the build status
[19:51:24.830] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:51:24.831] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:138:0) after 1m0s
[19:52:24.969] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:138:0)
[19:52:24.969] Timer tick, asking Buildbucket for the build status
[19:52:25.544] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:52:25.544] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:139:0) after 1m0s
[19:53:25.638] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:139:0)
[19:53:25.638] Timer tick, asking Buildbucket for the build status
[19:53:26.307] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:53:26.307] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:140:0) after 1m0s
[19:54:26.462] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:140:0)
[19:54:26.462] Timer tick, asking Buildbucket for the build status
[19:54:26.618] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:54:26.618] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:141:0) after 1m0s
[19:55:26.679] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:141:0)
[19:55:26.679] Timer tick, asking Buildbucket for the build status
[19:55:26.973] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:55:26.973] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:142:0) after 1m0s
[19:56:27.111] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:142:0)
[19:56:27.111] Timer tick, asking Buildbucket for the build status
[19:56:27.474] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:56:27.474] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:143:0) after 1m0s
[19:57:27.692] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:143:0)
[19:57:27.692] Timer tick, asking Buildbucket for the build status
[19:57:27.837] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:57:27.838] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:144:0) after 1m0s
[19:58:28.005] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:144:0)
[19:58:28.005] Timer tick, asking Buildbucket for the build status
[19:58:28.231] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:58:28.231] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:145:0) after 1m0s
[19:59:28.414] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:145:0)
[19:59:28.414] Timer tick, asking Buildbucket for the build status
[19:59:28.611] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:59:28.611] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:146:0) after 1m0s
[20:00:28.763] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:146:0)
[20:00:28.763] Timer tick, asking Buildbucket for the build status
[20:00:29.325] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:00:29.325] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:147:0) after 1m0s
[20:01:29.596] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:147:0)
[20:01:29.596] Timer tick, asking Buildbucket for the build status
[20:01:30.146] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:01:30.146] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:148:0) after 1m0s
[20:02:30.192] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:148:0)
[20:02:30.192] Timer tick, asking Buildbucket for the build status
[20:02:30.327] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:02:30.327] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:149:0) after 1m0s
[20:03:30.475] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:149:0)
[20:03:30.475] Timer tick, asking Buildbucket for the build status
[20:03:30.981] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:03:30.981] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:150:0) after 1m0s
[20:04:31.182] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:150:0)
[20:04:31.182] Timer tick, asking Buildbucket for the build status
[20:04:31.734] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:04:31.734] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:151:0) after 1m0s
[20:05:31.865] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:151:0)
[20:05:31.865] Timer tick, asking Buildbucket for the build status
[20:05:32.217] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:05:32.217] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:152:0) after 1m0s
[20:06:32.296] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:152:0)
[20:06:32.296] Timer tick, asking Buildbucket for the build status
[20:06:32.529] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:06:32.529] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:153:0) after 1m0s
[20:07:33.164] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:153:0)
[20:07:33.164] Timer tick, asking Buildbucket for the build status
[20:07:33.993] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:07:33.993] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:154:0) after 1m0s
[20:08:34.130] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:154:0)
[20:08:34.130] Timer tick, asking Buildbucket for the build status
[20:08:34.563] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:08:34.563] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:155:0) after 1m0s
[20:09:34.920] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:155:0)
[20:09:34.920] Timer tick, asking Buildbucket for the build status
[20:09:35.437] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:09:35.437] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:156:0) after 1m0s
[20:10:35.565] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:156:0)
[20:10:35.565] Timer tick, asking Buildbucket for the build status
[20:10:35.868] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:10:35.868] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:157:0) after 1m0s
[20:11:36.083] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:157:0)
[20:11:36.083] Timer tick, asking Buildbucket for the build status
[20:11:36.753] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:11:36.753] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:158:0) after 1m0s
[20:12:36.873] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:158:0)
[20:12:36.873] Timer tick, asking Buildbucket for the build status
[20:12:37.097] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:12:37.097] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:159:0) after 1m0s
[20:13:37.179] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:159:0)
[20:13:37.179] Timer tick, asking Buildbucket for the build status
[20:13:37.345] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:13:37.345] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:160:0) after 1m0s
[20:14:37.507] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:160:0)
[20:14:37.507] Timer tick, asking Buildbucket for the build status
[20:14:37.824] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:14:37.824] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:161:0) after 1m0s
[20:15:37.890] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:161:0)
[20:15:37.890] Timer tick, asking Buildbucket for the build status
[20:15:38.000] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:15:38.000] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:162:0) after 1m0s
[20:16:38.303] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:162:0)
[20:16:38.303] Timer tick, asking Buildbucket for the build status
[20:16:39.461] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:16:39.461] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:163:0) after 1m0s
[20:17:39.778] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:163:0)
[20:17:39.778] Timer tick, asking Buildbucket for the build status
[20:17:40.102] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:17:40.103] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:164:0) after 1m0s
[20:18:40.225] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:164:0)
[20:18:40.225] Timer tick, asking Buildbucket for the build status
[20:18:40.853] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:18:40.854] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:165:0) after 1m0s
[20:19:41.009] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:165:0)
[20:19:41.009] Timer tick, asking Buildbucket for the build status
[20:19:41.317] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:19:41.317] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:166:0) after 1m0s
[20:20:41.397] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:166:0)
[20:20:41.397] Timer tick, asking Buildbucket for the build status
[20:20:41.726] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:20:41.726] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:167:0) after 1m0s
[20:21:41.858] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:167:0)
[20:21:41.858] Timer tick, asking Buildbucket for the build status
[20:21:42.074] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:21:42.074] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:168:0) after 1m0s
[20:22:42.105] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:168:0)
[20:22:42.105] Timer tick, asking Buildbucket for the build status
[20:22:42.774] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:22:42.774] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:169:0) after 1m0s
[20:23:42.850] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:169:0)
[20:23:42.850] Timer tick, asking Buildbucket for the build status
[20:23:43.448] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:23:43.448] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:170:0) after 1m0s
[20:24:43.547] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:170:0)
[20:24:43.547] Timer tick, asking Buildbucket for the build status
[20:24:43.984] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:24:43.984] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:171:0) after 1m0s
[20:25:44.078] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:171:0)
[20:25:44.078] Timer tick, asking Buildbucket for the build status
[20:25:44.583] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:25:44.583] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:172:0) after 1m0s
[20:26:44.832] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:172:0)
[20:26:44.832] Timer tick, asking Buildbucket for the build status
[20:26:46.494] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:26:46.494] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:173:0) after 1m0s
[20:27:46.761] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:173:0)
[20:27:46.761] Timer tick, asking Buildbucket for the build status
[20:27:47.501] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:27:47.502] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:174:0) after 1m0s
[20:28:47.704] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:174:0)
[20:28:47.704] Timer tick, asking Buildbucket for the build status
[20:28:48.108] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:28:48.108] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:175:0) after 1m0s
[20:29:48.385] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:175:0)
[20:29:48.385] Timer tick, asking Buildbucket for the build status
[20:29:48.778] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:29:48.778] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:176:0) after 1m0s
[20:30:49.095] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:176:0)
[20:30:49.095] Timer tick, asking Buildbucket for the build status
[20:30:49.546] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:30:49.546] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:177:0) after 1m0s
[20:31:49.547] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:177:0)
[20:31:49.547] Timer tick, asking Buildbucket for the build status
[20:31:50.438] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:31:50.438] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:178:0) after 1m0s
[20:32:50.554] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:178:0)
[20:32:50.554] Timer tick, asking Buildbucket for the build status
[20:32:50.877] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:32:50.877] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:179:0) after 1m0s
[20:33:50.975] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:179:0)
[20:33:50.975] Timer tick, asking Buildbucket for the build status
[20:33:51.185] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:33:51.185] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:180:0) after 1m0s
[20:34:51.413] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:180:0)
[20:34:51.413] Timer tick, asking Buildbucket for the build status
[20:34:51.591] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:34:51.591] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:181:0) after 1m0s
[20:35:51.764] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:181:0)
[20:35:51.764] Timer tick, asking Buildbucket for the build status
[20:35:52.289] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:35:52.289] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:182:0) after 1m0s
[20:36:52.416] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:182:0)
[20:36:52.416] Timer tick, asking Buildbucket for the build status
[20:36:52.716] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:36:52.716] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:183:0) after 1m0s
[20:37:52.857] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:183:0)
[20:37:52.857] Timer tick, asking Buildbucket for the build status
[20:37:53.013] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:37:53.014] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:184:0) after 1m0s
[20:38:53.116] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:184:0)
[20:38:53.117] Timer tick, asking Buildbucket for the build status
[20:38:53.799] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:38:53.799] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:185:0) after 1m0s
[20:39:53.883] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:185:0)
[20:39:53.883] Timer tick, asking Buildbucket for the build status
[20:39:55.376] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:39:55.376] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:186:0) after 1m0s
[20:40:55.400] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:186:0)
[20:40:55.400] Timer tick, asking Buildbucket for the build status
[20:40:55.750] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:40:55.750] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:187:0) after 1m0s
[20:41:55.797] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:187:0)
[20:41:55.797] Timer tick, asking Buildbucket for the build status
[20:41:56.038] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:41:56.038] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:188:0) after 1m0s
[20:42:56.218] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:188:0)
[20:42:56.218] Timer tick, asking Buildbucket for the build status
[20:42:56.460] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:42:56.460] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:189:0) after 1m0s
[20:43:56.517] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:189:0)
[20:43:56.517] Timer tick, asking Buildbucket for the build status
[20:43:57.355] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:43:57.355] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:190:0) after 1m0s
[20:44:57.385] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:190:0)
[20:44:57.385] Timer tick, asking Buildbucket for the build status
[20:44:57.713] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:44:57.713] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:191:0) after 1m0s
[20:45:57.927] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:191:0)
[20:45:57.927] Timer tick, asking Buildbucket for the build status
[20:45:58.363] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:45:58.363] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:192:0) after 1m0s
[20:46:58.473] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:192:0)
[20:46:58.473] Timer tick, asking Buildbucket for the build status
[20:46:58.627] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:46:58.627] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:193:0) after 1m0s
[20:47:58.841] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:193:0)
[20:47:58.841] Timer tick, asking Buildbucket for the build status
[20:47:59.028] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:47:59.028] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:194:0) after 1m0s
[20:48:59.087] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:194:0)
[20:48:59.087] Timer tick, asking Buildbucket for the build status
[20:48:59.528] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:48:59.528] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:195:0) after 1m0s
[20:49:59.603] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:195:0)
[20:49:59.603] Timer tick, asking Buildbucket for the build status
[20:50:00.077] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:50:00.077] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:196:0) after 1m0s
[20:51:00.221] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:196:0)
[20:51:00.221] Timer tick, asking Buildbucket for the build status
[20:51:00.620] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:51:00.620] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:197:0) after 1m0s
[20:52:00.735] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:197:0)
[20:52:00.735] Timer tick, asking Buildbucket for the build status
[20:52:00.932] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:52:00.932] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:198:0) after 1m0s
[20:53:00.976] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:198:0)
[20:53:00.976] Timer tick, asking Buildbucket for the build status
[20:53:01.230] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:53:01.230] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:199:0) after 1m0s
[20:54:01.341] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:199:0)
[20:54:01.341] Timer tick, asking Buildbucket for the build status
[20:54:01.598] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:54:01.598] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:200:0) after 1m0s
[20:55:02.105] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:200:0)
[20:55:02.105] Timer tick, asking Buildbucket for the build status
[20:55:02.346] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:55:02.346] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:201:0) after 1m0s
[20:56:02.573] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:201:0)
[20:56:02.573] Timer tick, asking Buildbucket for the build status
[20:56:02.809] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:56:02.809] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:202:0) after 1m0s
[20:57:02.822] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:202:0)
[20:57:02.822] Timer tick, asking Buildbucket for the build status
[20:57:03.164] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:57:03.164] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:203:0) after 1m0s
[20:58:03.385] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:203:0)
[20:58:03.385] Timer tick, asking Buildbucket for the build status
[20:58:04.378] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:58:04.378] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:204:0) after 1m0s
[20:59:04.526] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:204:0)
[20:59:04.526] Timer tick, asking Buildbucket for the build status
[20:59:04.706] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:59:04.706] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:205:0) after 1m0s
[21:00:04.752] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:205:0)
[21:00:04.752] Timer tick, asking Buildbucket for the build status
[21:00:05.092] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:00:05.092] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:206:0) after 1m0s
[21:01:05.197] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:206:0)
[21:01:05.197] Timer tick, asking Buildbucket for the build status
[21:01:05.405] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:01:05.405] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:207:0) after 1m0s
[21:02:05.479] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:207:0)
[21:02:05.479] Timer tick, asking Buildbucket for the build status
[21:02:06.141] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:02:06.141] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:208:0) after 1m0s
[21:03:06.280] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:208:0)
[21:03:06.280] Timer tick, asking Buildbucket for the build status
[21:03:06.735] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:03:06.735] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:209:0) after 1m0s
[21:04:06.872] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:209:0)
[21:04:06.872] Timer tick, asking Buildbucket for the build status
[21:04:07.122] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:04:07.122] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:210:0) after 1m0s
[21:05:07.183] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:210:0)
[21:05:07.183] Timer tick, asking Buildbucket for the build status
[21:05:07.446] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:05:07.446] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:211:0) after 1m0s
[21:06:07.552] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:211:0)
[21:06:07.552] Timer tick, asking Buildbucket for the build status
[21:06:08.008] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:06:08.008] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:212:0) after 1m0s
[21:07:08.203] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:212:0)
[21:07:08.203] Timer tick, asking Buildbucket for the build status
[21:07:08.630] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:07:08.630] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:213:0) after 1m0s
[21:08:08.725] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:213:0)
[21:08:08.725] Timer tick, asking Buildbucket for the build status
[21:08:08.902] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:08:08.902] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:214:0) after 1m0s
[21:09:09.310] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:214:0)
[21:09:09.310] Timer tick, asking Buildbucket for the build status
[21:09:09.619] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:09:09.619] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:215:0) after 1m0s
[21:10:09.858] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:215:0)
[21:10:09.858] Timer tick, asking Buildbucket for the build status
[21:10:11.263] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:10:11.263] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:216:0) after 1m0s
[21:11:11.440] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:216:0)
[21:11:11.440] Timer tick, asking Buildbucket for the build status
[21:11:11.781] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:11:11.781] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:217:0) after 1m0s
[21:12:11.910] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:217:0)
[21:12:11.910] Timer tick, asking Buildbucket for the build status
[21:12:12.094] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:12:12.094] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:218:0) after 1m0s
[21:13:12.324] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:218:0)
[21:13:12.324] Timer tick, asking Buildbucket for the build status
[21:13:14.108] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:13:14.108] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:219:0) after 1m0s
[21:14:14.391] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:219:0)
[21:14:14.391] Timer tick, asking Buildbucket for the build status
[21:14:14.744] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:14:14.744] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:220:0) after 1m0s
[21:15:15.012] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:220:0)
[21:15:15.012] Timer tick, asking Buildbucket for the build status
[21:15:15.501] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:15:15.501] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:221:0) after 1m0s
[21:16:15.664] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:221:0)
[21:16:15.664] Timer tick, asking Buildbucket for the build status
[21:16:16.727] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:16:16.727] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:222:0) after 1m0s
[21:17:16.986] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:222:0)
[21:17:16.986] Timer tick, asking Buildbucket for the build status
[21:17:17.333] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:17:17.333] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:223:0) after 1m0s
[21:18:17.482] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:223:0)
[21:18:17.482] Timer tick, asking Buildbucket for the build status
[21:18:17.694] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:18:17.694] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:224:0) after 1m0s
[21:19:17.865] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:224:0)
[21:19:17.865] Timer tick, asking Buildbucket for the build status
[21:19:20.290] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:19:20.290] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:225:0) after 1m0s
[21:20:20.543] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:225:0)
[21:20:20.543] Timer tick, asking Buildbucket for the build status
[21:20:21.269] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:20:21.269] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:226:0) after 1m0s
[21:21:21.379] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:226:0)
[21:21:21.379] Timer tick, asking Buildbucket for the build status
[21:21:21.583] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:21:21.583] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:227:0) after 1m0s
[21:22:21.692] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:227:0)
[21:22:21.692] Timer tick, asking Buildbucket for the build status
[21:22:22.015] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:22:22.015] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:228:0) after 1m0s
[21:23:22.461] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:228:0)
[21:23:22.461] Timer tick, asking Buildbucket for the build status
[21:23:23.109] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:23:23.109] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:229:0) after 1m0s
[21:24:23.171] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:229:0)
[21:24:23.171] Timer tick, asking Buildbucket for the build status
[21:24:23.407] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:24:23.407] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:230:0) after 1m0s
[21:25:23.655] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:230:0)
[21:25:23.655] Timer tick, asking Buildbucket for the build status
[21:25:24.340] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:25:24.340] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:231:0) after 1m0s
[21:26:24.430] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:231:0)
[21:26:24.430] Timer tick, asking Buildbucket for the build status
[21:26:24.624] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:26:24.624] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:232:0) after 1m0s
[21:27:24.773] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:232:0)
[21:27:24.773] Timer tick, asking Buildbucket for the build status
[21:27:25.034] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:27:25.034] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:233:0) after 1m0s
[21:28:25.144] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:233:0)
[21:28:25.144] Timer tick, asking Buildbucket for the build status
[21:28:27.483] Build 8894257508904337264: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:28:27.483] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9059687571524564720:234:0) after 1m0s
[21:28:33.755] Received PubSub notification, asking Buildbucket for the build status
[21:28:34.021] Build 8894257508904337264: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[21:28:34.021] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1576186113235497",
"created_by": "project:chromium",
"created_ts": "1576172072462475",
"failure_reason": "BUILD_FAILURE",
"id": "8894257508904337264",
"parameters_json": "{\"builder_name\": \"Windows deterministic\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"3c29c8546feda9e6a2adf9233bd91e781f732da2\"}}",
"project": "chromium",
"result": "FAILURE",
"result_details_json": "{\"error\": {\"message\": \"Step('compare_build_artifacts') (retcode: 1)\"}, \"properties\": {\"$build/goma\": {\"enable_ats\": true, \"rpc_extra_params\": \"?prod\", \"server_host\": \"goma.chromium.org\"}, \"$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\": \"windows-deterministic-0-vps3\", \"branch\": \"refs/heads/master\", \"buildername\": \"Windows deterministic\", \"buildnumber\": 15441, \"got_angle_revision\": \"d5ac2e89d243fa86672877bbd01f30cc8cb0e8ce\", \"got_dawn_revision\": \"69cdaf94dfb127fadc354883d423b63b4e4c3cb1\", \"got_nacl_revision\": \"3651f6c52037c96e034cc422746768d59182bff3\", \"got_revision\": \"3c29c8546feda9e6a2adf9233bd91e781f732da2\", \"got_revision_cp\": \"refs/heads/master@{#724241}\", \"got_swarming_client_revision\": \"885b3febcc170a60f25795304e60927b77d1e92d\", \"got_swiftshader_revision\": \"07958d452f93b6513ebf5cbae64a1325c1755dbf\", \"got_v8_revision\": \"5bc9d1fd5825c04e080c106f500c984b3b6ea33f\", \"got_v8_revision_cp\": \"refs/heads/8.1.19@{#1}\", \"got_webrtc_revision\": \"26fe811623627e1089a8df2c86a89dda2cd9d338\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#30068}\", \"mastername\": \"chromium.win\", \"path_config\": \"generic\", \"recipe\": \"swarming/deterministic_build\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"3c29c8546feda9e6a2adf9233bd91e781f732da2\"}, \"swarming\": {\"bot_dimensions\": {\"builder\": [\"Windows deterministic\"], \"caches\": [\"builder_e8fffaf9fac16164b1ec16ebaa1f377b792d39a582f7640830518d8ff7303d0c_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"8\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\"], \"gce\": [\"1\"], \"gpu\": [\"none\"], \"id\": [\"windows-deterministic-0-vps3\"], \"image\": [\"chrome-win10-1703-19112100-3085293b610\"], \"integrity\": [\"high\"], \"locale\": [\"en_US.cp1252\"], \"machine_type\": [\"n1-standard-8\"], \"os\": [\"Windows\", \"Windows-10\", \"Windows-10-15063\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.13\"], \"server_version\": [\"4713-a14a20b\"], \"ssd\": [\"0\"], \"windows_client_version\": [\"10\"], \"zone\": [\"us\", \"us-west\", \"us-west1\", \"us-west1-c\"]}}, \"ui\": {\"info\": \"Step('compare_build_artifacts') (retcode: 1)\"}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1576172703517455",
"status": "COMPLETED",
"status_changed_ts": "1576172704100785",
"tags": [
"build_address:luci.chromium.ci/Windows deterministic/15441",
"builder:Windows deterministic",
"buildset:commit/git/3c29c8546feda9e6a2adf9233bd91e781f732da2",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/3c29c8546feda9e6a2adf9233bd91e781f732da2",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9059687571524564720",
"scheduler_job_id:chromium/Windows deterministic",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8894257508904337264/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:os:Windows",
"swarming_tag:recipe_name:swarming/deterministic_build",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:4913feceee78f610",
"user_agent:luci-scheduler"
],
"updated_ts": "1576186113317484",
"url": "https://ci.chromium.org/b/8894257508904337264",
"utcnow_ts": "1576186114003735"
}
}
[21:28:34.021] Invocation finished in 3h54m3.440991663s with status FAILED