[12:20:48.128] New invocation is queued and will start shortly
[12:20:49.387] Starting the invocation (attempt 1)
[12:20:49.427] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[12:20:49.427] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[12:20:49.427] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9097758034200623680",
"parameters_json": "{\"builder_name\":\"Windows deterministic\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src.git\",\"revision\":\"43116fdd290fd13d324df39e20d3825f5851ca1a\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:Windows deterministic",
"scheduler_invocation_id:9097758034200623680",
"scheduler_job_id:chromium/Windows deterministic",
"user_agent:luci-scheduler",
"buildset:commit/git/43116fdd290fd13d324df39e20d3825f5851ca1a",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/43116fdd290fd13d324df39e20d3825f5851ca1a",
"gitiles_ref:refs/heads/master"
]
}
[12:20:51.287] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "AUTO",
"created_by": "user:luci-scheduler@appspot.gserviceaccount.com",
"created_ts": "1539865249614860",
"id": "8932327971979171184",
"lease_expiration_ts": "1540009250838898",
"lease_key": "1497735784",
"parameters_json": "{\"builder_name\": \"Windows deterministic\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src.git\", \"revision\": \"43116fdd290fd13d324df39e20d3825f5851ca1a\"}}",
"project": "chromium",
"result_details_json": "null",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1539865251159010",
"tags": [
"build_address:luci.chromium.ci/Windows deterministic/10441",
"builder:Windows deterministic",
"buildset:commit/git/43116fdd290fd13d324df39e20d3825f5851ca1a",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/43116fdd290fd13d324df39e20d3825f5851ca1a",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9097758034200623680",
"scheduler_job_id:chromium/Windows deterministic",
"swarming_dimension:builder:Windows deterministic",
"swarming_dimension:caches:builder_d795d6e07fe37a299fcfc0e872e48757ad306282f024125f803c0465bfd1eeae_v2",
"swarming_dimension:cores:8",
"swarming_dimension:cpu:x86-64",
"swarming_dimension:os:Windows-10",
"swarming_dimension:pool:luci.chromium.ci",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:build_address:luci.chromium.ci/Windows deterministic/10441",
"swarming_tag:buildbucket_bucket:luci.chromium.ci",
"swarming_tag:buildbucket_build_id:8932327971979171184",
"swarming_tag:buildbucket_hostname:cr-buildbucket.appspot.com",
"swarming_tag:buildbucket_template_canary:0",
"swarming_tag:buildbucket_template_revision:124eed49d11e136feabd3af4ed5694849cf76783",
"swarming_tag:builder:Windows deterministic",
"swarming_tag:buildset:commit/git/43116fdd290fd13d324df39e20d3825f5851ca1a",
"swarming_tag:buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/43116fdd290fd13d324df39e20d3825f5851ca1a",
"swarming_tag:caches:builder_d795d6e07fe37a299fcfc0e872e48757ad306282f024125f803c0465bfd1eeae_v2",
"swarming_tag:cores:8",
"swarming_tag:cpu:x86-64",
"swarming_tag:gitiles_ref:refs/heads/master",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8932327971979171184/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:os:Windows-10",
"swarming_tag:pool:luci.chromium.ci",
"swarming_tag:priority:30",
"swarming_tag:recipe_name:swarming/deterministic_build",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_tag:scheduler_invocation_id:9097758034200623680",
"swarming_tag:scheduler_job_id:chromium/Windows deterministic",
"swarming_tag:service_account:chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"swarming_tag:swarming.pool.template:skip",
"swarming_tag:swarming.pool.version:16d89b69cb6383fd143444068fba8510114d6c27",
"swarming_tag:user:None",
"swarming_tag:user_agent:luci-scheduler",
"swarming_tag:vpython:native-python-wrapper",
"swarming_task_id:409ff09257c62510",
"user_agent:luci-scheduler"
],
"updated_ts": "1539865251159124",
"url": "https://ci.chromium.org/p/chromium/builders/luci.chromium.ci/Windows deterministic/10441",
"utcnow_ts": "1539865251277350"
}
}
[12:20:51.287] Task URL: https://ci.chromium.org/p/chromium/builders/luci.chromium.ci/Windows deterministic/10441
[12:20:51.287] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:2:0) after 1m0s
[12:20:53.997] Received PubSub notification, asking Buildbucket for the build status
[12:20:54.072] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:21:51.309] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:2:0)
[12:21:51.310] Timer tick, asking Buildbucket for the build status
[12:21:51.378] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:21:51.378] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:4:0) after 1m0s
[12:22:51.476] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:4:0)
[12:22:51.476] Timer tick, asking Buildbucket for the build status
[12:22:51.515] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:22:51.515] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:5:0) after 1m0s
[12:23:51.544] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:5:0)
[12:23:51.544] Timer tick, asking Buildbucket for the build status
[12:23:51.636] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:23:51.636] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:6:0) after 1m0s
[12:24:51.658] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:6:0)
[12:24:51.658] Timer tick, asking Buildbucket for the build status
[12:24:51.857] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:24:51.857] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:7:0) after 1m0s
[12:25:51.953] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:7:0)
[12:25:51.953] Timer tick, asking Buildbucket for the build status
[12:25:52.006] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:25:52.006] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:8:0) after 1m0s
[12:26:52.024] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:8:0)
[12:26:52.024] Timer tick, asking Buildbucket for the build status
[12:26:52.104] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:26:52.104] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:9:0) after 1m0s
[12:27:52.166] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:9:0)
[12:27:52.166] Timer tick, asking Buildbucket for the build status
[12:27:52.335] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:27:52.335] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:10:0) after 1m0s
[12:28:52.351] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:10:0)
[12:28:52.351] Timer tick, asking Buildbucket for the build status
[12:28:52.412] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:28:52.412] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:11:0) after 1m0s
[12:29:52.443] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:11:0)
[12:29:52.443] Timer tick, asking Buildbucket for the build status
[12:29:52.489] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:29:52.489] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:12:0) after 1m0s
[12:30:52.523] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:12:0)
[12:30:52.523] Timer tick, asking Buildbucket for the build status
[12:30:52.646] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:30:52.646] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:13:0) after 1m0s
[12:31:52.666] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:13:0)
[12:31:52.666] Timer tick, asking Buildbucket for the build status
[12:31:52.730] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:31:52.730] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:14:0) after 1m0s
[12:32:52.747] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:14:0)
[12:32:52.747] Timer tick, asking Buildbucket for the build status
[12:32:52.826] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:32:52.826] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:15:0) after 1m0s
[12:33:52.848] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:15:0)
[12:33:52.848] Timer tick, asking Buildbucket for the build status
[12:33:52.904] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:33:52.904] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:16:0) after 1m0s
[12:34:52.923] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:16:0)
[12:34:52.923] Timer tick, asking Buildbucket for the build status
[12:34:52.978] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:34:52.978] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:17:0) after 1m0s
[12:35:53.000] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:17:0)
[12:35:53.000] Timer tick, asking Buildbucket for the build status
[12:35:53.091] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:35:53.091] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:18:0) after 1m0s
[12:36:53.160] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:18:0)
[12:36:53.160] Timer tick, asking Buildbucket for the build status
[12:36:53.323] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:36:53.323] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:19:0) after 1m0s
[12:37:53.341] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:19:0)
[12:37:53.341] Timer tick, asking Buildbucket for the build status
[12:37:54.345] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:37:54.345] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:20:0) after 1m0s
[12:38:54.366] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:20:0)
[12:38:54.366] Timer tick, asking Buildbucket for the build status
[12:38:54.526] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:38:54.526] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:21:0) after 1m0s
[12:39:54.547] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:21:0)
[12:39:54.547] Timer tick, asking Buildbucket for the build status
[12:39:54.819] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:39:54.820] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:22:0) after 1m0s
[12:40:54.837] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:22:0)
[12:40:54.837] Timer tick, asking Buildbucket for the build status
[12:40:55.045] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:40:55.045] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:23:0) after 1m0s
[12:41:55.123] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:23:0)
[12:41:55.123] Timer tick, asking Buildbucket for the build status
[12:41:55.240] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:41:55.240] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:24:0) after 1m0s
[12:42:55.261] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:24:0)
[12:42:55.261] Timer tick, asking Buildbucket for the build status
[12:42:55.331] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:42:55.331] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:25:0) after 1m0s
[12:43:55.350] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:25:0)
[12:43:55.350] Timer tick, asking Buildbucket for the build status
[12:43:55.439] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:43:55.439] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:26:0) after 1m0s
[12:44:55.457] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:26:0)
[12:44:55.457] Timer tick, asking Buildbucket for the build status
[12:44:55.532] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:44:55.532] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:27:0) after 1m0s
[12:45:55.551] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:27:0)
[12:45:55.551] Timer tick, asking Buildbucket for the build status
[12:45:55.931] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:45:55.931] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:28:0) after 1m0s
[12:46:55.951] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:28:0)
[12:46:55.951] Timer tick, asking Buildbucket for the build status
[12:46:56.124] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:46:56.124] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:29:0) after 1m0s
[12:47:56.204] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:29:0)
[12:47:56.204] Timer tick, asking Buildbucket for the build status
[12:47:56.264] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:47:56.264] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:30:0) after 1m0s
[12:48:56.345] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:30:0)
[12:48:56.345] Timer tick, asking Buildbucket for the build status
[12:48:56.608] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:48:56.608] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:31:0) after 1m0s
[12:49:56.625] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:31:0)
[12:49:56.625] Timer tick, asking Buildbucket for the build status
[12:49:56.770] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:49:56.770] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:32:0) after 1m0s
[12:50:56.841] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:32:0)
[12:50:56.841] Timer tick, asking Buildbucket for the build status
[12:50:57.030] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:50:57.030] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:33:0) after 1m0s
[12:51:57.127] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:33:0)
[12:51:57.127] Timer tick, asking Buildbucket for the build status
[12:51:57.201] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:51:57.201] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:34:0) after 1m0s
[12:52:57.222] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:34:0)
[12:52:57.222] Timer tick, asking Buildbucket for the build status
[12:52:57.942] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:52:57.942] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:35:0) after 1m0s
[12:53:58.015] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:35:0)
[12:53:58.015] Timer tick, asking Buildbucket for the build status
[12:53:58.140] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:53:58.140] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:36:0) after 1m0s
[12:54:58.174] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:36:0)
[12:54:58.174] Timer tick, asking Buildbucket for the build status
[12:54:58.424] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:54:58.424] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:37:0) after 1m0s
[12:55:58.466] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:37:0)
[12:55:58.466] Timer tick, asking Buildbucket for the build status
[12:55:58.543] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:55:58.543] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:38:0) after 1m0s
[12:56:58.562] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:38:0)
[12:56:58.562] Timer tick, asking Buildbucket for the build status
[12:56:58.693] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:56:58.693] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:39:0) after 1m0s
[12:57:58.764] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:39:0)
[12:57:58.764] Timer tick, asking Buildbucket for the build status
[12:57:58.801] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:57:58.801] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:40:0) after 1m0s
[12:58:58.837] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:40:0)
[12:58:58.837] Timer tick, asking Buildbucket for the build status
[12:58:58.897] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:58:58.897] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:41:0) after 1m0s
[12:59:58.918] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:41:0)
[12:59:58.918] Timer tick, asking Buildbucket for the build status
[12:59:59.033] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:59:59.033] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:42:0) after 1m0s
[13:00:59.074] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:42:0)
[13:00:59.074] Timer tick, asking Buildbucket for the build status
[13:00:59.181] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:00:59.181] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:43:0) after 1m0s
[13:01:59.248] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:43:0)
[13:01:59.248] Timer tick, asking Buildbucket for the build status
[13:01:59.338] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:01:59.338] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:44:0) after 1m0s
[13:02:59.359] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:44:0)
[13:02:59.359] Timer tick, asking Buildbucket for the build status
[13:02:59.394] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:02:59.394] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:45:0) after 1m0s
[13:03:59.446] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:45:0)
[13:03:59.446] Timer tick, asking Buildbucket for the build status
[13:03:59.515] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:03:59.515] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:46:0) after 1m0s
[13:04:59.555] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:46:0)
[13:04:59.555] Timer tick, asking Buildbucket for the build status
[13:04:59.618] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:04:59.618] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:47:0) after 1m0s
[13:05:59.648] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:47:0)
[13:05:59.648] Timer tick, asking Buildbucket for the build status
[13:05:59.702] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:05:59.702] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:48:0) after 1m0s
[13:06:59.726] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:48:0)
[13:06:59.726] Timer tick, asking Buildbucket for the build status
[13:06:59.806] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:06:59.806] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:49:0) after 1m0s
[13:07:59.829] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:49:0)
[13:07:59.829] Timer tick, asking Buildbucket for the build status
[13:07:59.891] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:07:59.891] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:50:0) after 1m0s
[13:08:59.910] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:50:0)
[13:08:59.910] Timer tick, asking Buildbucket for the build status
[13:08:59.947] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:08:59.947] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:51:0) after 1m0s
[13:10:00.005] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:51:0)
[13:10:00.005] Timer tick, asking Buildbucket for the build status
[13:10:00.103] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:10:00.103] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:52:0) after 1m0s
[13:11:00.125] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:52:0)
[13:11:00.125] Timer tick, asking Buildbucket for the build status
[13:11:00.182] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:11:00.182] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:53:0) after 1m0s
[13:12:00.239] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:53:0)
[13:12:00.239] Timer tick, asking Buildbucket for the build status
[13:12:00.303] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:12:00.303] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:54:0) after 1m0s
[13:13:00.413] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:54:0)
[13:13:00.413] Timer tick, asking Buildbucket for the build status
[13:13:00.557] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:13:00.557] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:55:0) after 1m0s
[13:14:00.631] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:55:0)
[13:14:00.631] Timer tick, asking Buildbucket for the build status
[13:14:00.700] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:14:00.700] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:56:0) after 1m0s
[13:15:00.798] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:56:0)
[13:15:00.798] Timer tick, asking Buildbucket for the build status
[13:15:00.863] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:15:00.863] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:57:0) after 1m0s
[13:16:00.890] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:57:0)
[13:16:00.890] Timer tick, asking Buildbucket for the build status
[13:16:01.436] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:16:01.436] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:58:0) after 1m0s
[13:17:01.473] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:58:0)
[13:17:01.473] Timer tick, asking Buildbucket for the build status
[13:17:01.639] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:17:01.639] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:59:0) after 1m0s
[13:18:01.661] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:59:0)
[13:18:01.661] Timer tick, asking Buildbucket for the build status
[13:18:01.737] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:18:01.737] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:60:0) after 1m0s
[13:19:01.801] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:60:0)
[13:19:01.801] Timer tick, asking Buildbucket for the build status
[13:19:01.961] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:19:01.961] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:61:0) after 1m0s
[13:20:02.065] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:61:0)
[13:20:02.065] Timer tick, asking Buildbucket for the build status
[13:20:02.189] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:20:02.190] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:62:0) after 1m0s
[13:21:02.222] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:62:0)
[13:21:02.222] Timer tick, asking Buildbucket for the build status
[13:21:02.311] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:21:02.311] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:63:0) after 1m0s
[13:22:02.350] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:63:0)
[13:22:02.350] Timer tick, asking Buildbucket for the build status
[13:22:02.412] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:22:02.412] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:64:0) after 1m0s
[13:23:02.442] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:64:0)
[13:23:02.442] Timer tick, asking Buildbucket for the build status
[13:23:02.503] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:23:02.503] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:65:0) after 1m0s
[13:24:02.560] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:65:0)
[13:24:02.560] Timer tick, asking Buildbucket for the build status
[13:24:02.705] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:24:02.705] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:66:0) after 1m0s
[13:25:02.764] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:66:0)
[13:25:02.764] Timer tick, asking Buildbucket for the build status
[13:25:04.015] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:25:04.015] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:67:0) after 1m0s
[13:26:04.039] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:67:0)
[13:26:04.039] Timer tick, asking Buildbucket for the build status
[13:26:04.092] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:26:04.092] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:68:0) after 1m0s
[13:27:04.129] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:68:0)
[13:27:04.129] Timer tick, asking Buildbucket for the build status
[13:27:04.189] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:27:04.189] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:69:0) after 1m0s
[13:28:04.223] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:69:0)
[13:28:04.223] Timer tick, asking Buildbucket for the build status
[13:28:04.304] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:28:04.304] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:70:0) after 1m0s
[13:29:04.329] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:70:0)
[13:29:04.329] Timer tick, asking Buildbucket for the build status
[13:29:04.432] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:29:04.432] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:71:0) after 1m0s
[13:30:04.474] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:71:0)
[13:30:04.474] Timer tick, asking Buildbucket for the build status
[13:30:04.554] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:30:04.554] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:72:0) after 1m0s
[13:31:04.642] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:72:0)
[13:31:04.642] Timer tick, asking Buildbucket for the build status
[13:31:04.721] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:31:04.721] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:73:0) after 1m0s
[13:32:04.777] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:73:0)
[13:32:04.777] Timer tick, asking Buildbucket for the build status
[13:32:04.941] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:32:04.941] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:74:0) after 1m0s
[13:33:04.981] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:74:0)
[13:33:04.981] Timer tick, asking Buildbucket for the build status
[13:33:05.051] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:33:05.051] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:75:0) after 1m0s
[13:34:05.111] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:75:0)
[13:34:05.111] Timer tick, asking Buildbucket for the build status
[13:34:05.181] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:34:05.181] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:76:0) after 1m0s
[13:35:05.261] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:76:0)
[13:35:05.261] Timer tick, asking Buildbucket for the build status
[13:35:05.336] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:35:05.336] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:77:0) after 1m0s
[13:36:05.425] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:77:0)
[13:36:05.425] Timer tick, asking Buildbucket for the build status
[13:36:05.466] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:36:05.466] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:78:0) after 1m0s
[13:37:05.488] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:78:0)
[13:37:05.488] Timer tick, asking Buildbucket for the build status
[13:37:05.576] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:37:05.576] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:79:0) after 1m0s
[13:38:05.605] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:79:0)
[13:38:05.605] Timer tick, asking Buildbucket for the build status
[13:38:05.679] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:38:05.679] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:80:0) after 1m0s
[13:39:05.704] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:80:0)
[13:39:05.704] Timer tick, asking Buildbucket for the build status
[13:39:05.775] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:39:05.775] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:81:0) after 1m0s
[13:40:05.800] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:81:0)
[13:40:05.800] Timer tick, asking Buildbucket for the build status
[13:40:05.883] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:40:05.883] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:82:0) after 1m0s
[13:41:05.968] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:82:0)
[13:41:05.968] Timer tick, asking Buildbucket for the build status
[13:41:06.027] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:41:06.027] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:83:0) after 1m0s
[13:42:06.044] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:83:0)
[13:42:06.044] Timer tick, asking Buildbucket for the build status
[13:42:06.090] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:42:06.090] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:84:0) after 1m0s
[13:43:06.114] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:84:0)
[13:43:06.114] Timer tick, asking Buildbucket for the build status
[13:43:06.181] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:43:06.181] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:85:0) after 1m0s
[13:44:06.212] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:85:0)
[13:44:06.212] Timer tick, asking Buildbucket for the build status
[13:44:06.268] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:44:06.268] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:86:0) after 1m0s
[13:45:06.296] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:86:0)
[13:45:06.296] Timer tick, asking Buildbucket for the build status
[13:45:06.349] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:45:06.349] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:87:0) after 1m0s
[13:46:06.381] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:87:0)
[13:46:06.381] Timer tick, asking Buildbucket for the build status
[13:46:06.450] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:46:06.450] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:88:0) after 1m0s
[13:47:06.476] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:88:0)
[13:47:06.476] Timer tick, asking Buildbucket for the build status
[13:47:06.546] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:47:06.546] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:89:0) after 1m0s
[13:48:06.591] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:89:0)
[13:48:06.591] Timer tick, asking Buildbucket for the build status
[13:48:06.669] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:48:06.669] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:90:0) after 1m0s
[13:49:06.715] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:90:0)
[13:49:06.715] Timer tick, asking Buildbucket for the build status
[13:49:06.780] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:49:06.780] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:91:0) after 1m0s
[13:50:06.845] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:91:0)
[13:50:06.845] Timer tick, asking Buildbucket for the build status
[13:50:07.033] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:50:07.033] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:92:0) after 1m0s
[13:51:07.055] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:92:0)
[13:51:07.056] Timer tick, asking Buildbucket for the build status
[13:51:07.142] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:51:07.142] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:93:0) after 1m0s
[13:52:07.173] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:93:0)
[13:52:07.173] Timer tick, asking Buildbucket for the build status
[13:52:07.304] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:52:07.304] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:94:0) after 1m0s
[13:53:07.325] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:94:0)
[13:53:07.325] Timer tick, asking Buildbucket for the build status
[13:53:07.376] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:53:07.376] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:95:0) after 1m0s
[13:54:07.397] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:95:0)
[13:54:07.397] Timer tick, asking Buildbucket for the build status
[13:54:07.471] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:54:07.471] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:96:0) after 1m0s
[13:55:07.493] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:96:0)
[13:55:07.493] Timer tick, asking Buildbucket for the build status
[13:55:07.540] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:55:07.540] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:97:0) after 1m0s
[13:56:07.563] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:97:0)
[13:56:07.563] Timer tick, asking Buildbucket for the build status
[13:56:07.628] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:56:07.628] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:98:0) after 1m0s
[13:57:07.689] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:98:0)
[13:57:07.689] Timer tick, asking Buildbucket for the build status
[13:57:07.782] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:57:07.782] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:99:0) after 1m0s
[13:58:07.812] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:99:0)
[13:58:07.812] Timer tick, asking Buildbucket for the build status
[13:58:07.875] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:58:07.875] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:100:0) after 1m0s
[13:59:07.899] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:100:0)
[13:59:07.899] Timer tick, asking Buildbucket for the build status
[13:59:07.948] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:59:07.948] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:101:0) after 1m0s
[14:00:07.983] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:101:0)
[14:00:07.983] Timer tick, asking Buildbucket for the build status
[14:00:08.075] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:00:08.075] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:102:0) after 1m0s
[14:01:08.098] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:102:0)
[14:01:08.098] Timer tick, asking Buildbucket for the build status
[14:01:08.160] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:01:08.160] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:103:0) after 1m0s
[14:02:08.193] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:103:0)
[14:02:08.193] Timer tick, asking Buildbucket for the build status
[14:02:08.264] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:02:08.264] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:104:0) after 1m0s
[14:03:09.147] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:104:0)
[14:03:09.147] Timer tick, asking Buildbucket for the build status
[14:03:09.313] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:03:09.313] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:105:0) after 1m0s
[14:04:09.336] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:105:0)
[14:04:09.336] Timer tick, asking Buildbucket for the build status
[14:04:09.422] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:04:09.422] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:106:0) after 1m0s
[14:05:09.444] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:106:0)
[14:05:09.444] Timer tick, asking Buildbucket for the build status
[14:05:09.490] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:05:09.490] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:107:0) after 1m0s
[14:06:09.527] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:107:0)
[14:06:09.527] Timer tick, asking Buildbucket for the build status
[14:06:09.630] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:06:09.630] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:108:0) after 1m0s
[14:07:09.654] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:108:0)
[14:07:09.654] Timer tick, asking Buildbucket for the build status
[14:07:09.793] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:07:09.793] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:109:0) after 1m0s
[14:08:09.817] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:109:0)
[14:08:09.817] Timer tick, asking Buildbucket for the build status
[14:08:09.879] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:08:09.879] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:110:0) after 1m0s
[14:09:09.911] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:110:0)
[14:09:09.911] Timer tick, asking Buildbucket for the build status
[14:09:10.030] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:09:10.030] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:111:0) after 1m0s
[14:10:10.063] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:111:0)
[14:10:10.063] Timer tick, asking Buildbucket for the build status
[14:10:10.277] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:10:10.277] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:112:0) after 1m0s
[14:11:10.345] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:112:0)
[14:11:10.345] Timer tick, asking Buildbucket for the build status
[14:11:10.432] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:11:10.432] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:113:0) after 1m0s
[14:12:10.453] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:113:0)
[14:12:10.453] Timer tick, asking Buildbucket for the build status
[14:12:10.565] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:12:10.565] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:114:0) after 1m0s
[14:13:10.590] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:114:0)
[14:13:10.590] Timer tick, asking Buildbucket for the build status
[14:13:10.792] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:13:10.792] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:115:0) after 1m0s
[14:14:10.813] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:115:0)
[14:14:10.813] Timer tick, asking Buildbucket for the build status
[14:14:11.041] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:14:11.041] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:116:0) after 1m0s
[14:15:11.066] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:116:0)
[14:15:11.066] Timer tick, asking Buildbucket for the build status
[14:15:11.130] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:15:11.130] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:117:0) after 1m0s
[14:16:11.153] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:117:0)
[14:16:11.153] Timer tick, asking Buildbucket for the build status
[14:16:11.296] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:16:11.296] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:118:0) after 1m0s
[14:17:11.339] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:118:0)
[14:17:11.339] Timer tick, asking Buildbucket for the build status
[14:17:11.434] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:17:11.434] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:119:0) after 1m0s
[14:18:11.457] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:119:0)
[14:18:11.457] Timer tick, asking Buildbucket for the build status
[14:18:11.549] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:18:11.549] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:120:0) after 1m0s
[14:19:11.577] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:120:0)
[14:19:11.577] Timer tick, asking Buildbucket for the build status
[14:19:11.704] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:19:11.704] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:121:0) after 1m0s
[14:20:11.727] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:121:0)
[14:20:11.727] Timer tick, asking Buildbucket for the build status
[14:20:11.783] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:20:11.783] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:122:0) after 1m0s
[14:21:11.817] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:122:0)
[14:21:11.817] Timer tick, asking Buildbucket for the build status
[14:21:11.899] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:21:11.899] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:123:0) after 1m0s
[14:22:11.979] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:123:0)
[14:22:11.979] Timer tick, asking Buildbucket for the build status
[14:22:12.081] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:22:12.081] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:124:0) after 1m0s
[14:23:12.122] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:124:0)
[14:23:12.122] Timer tick, asking Buildbucket for the build status
[14:23:12.244] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:23:12.244] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:125:0) after 1m0s
[14:24:12.272] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:125:0)
[14:24:12.272] Timer tick, asking Buildbucket for the build status
[14:24:12.383] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:24:12.383] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:126:0) after 1m0s
[14:25:12.442] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:126:0)
[14:25:12.442] Timer tick, asking Buildbucket for the build status
[14:25:12.518] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:25:12.518] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:127:0) after 1m0s
[14:26:12.546] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:127:0)
[14:26:12.546] Timer tick, asking Buildbucket for the build status
[14:26:12.843] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:26:12.843] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:128:0) after 1m0s
[14:27:12.866] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:128:0)
[14:27:12.866] Timer tick, asking Buildbucket for the build status
[14:27:13.164] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:27:13.164] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:129:0) after 1m0s
[14:28:13.195] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:129:0)
[14:28:13.195] Timer tick, asking Buildbucket for the build status
[14:28:13.241] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:28:13.241] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:130:0) after 1m0s
[14:29:13.347] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:130:0)
[14:29:13.347] Timer tick, asking Buildbucket for the build status
[14:29:13.385] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:29:13.385] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:131:0) after 1m0s
[14:30:13.496] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:131:0)
[14:30:13.496] Timer tick, asking Buildbucket for the build status
[14:30:13.600] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:30:13.600] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:132:0) after 1m0s
[14:31:13.652] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:132:0)
[14:31:13.652] Timer tick, asking Buildbucket for the build status
[14:31:13.717] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:31:13.717] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:133:0) after 1m0s
[14:32:13.762] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:133:0)
[14:32:13.762] Timer tick, asking Buildbucket for the build status
[14:32:13.802] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:32:13.802] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:134:0) after 1m0s
[14:33:13.826] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:134:0)
[14:33:13.826] Timer tick, asking Buildbucket for the build status
[14:33:13.976] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:33:13.976] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:135:0) after 1m0s
[14:34:14.001] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:135:0)
[14:34:14.001] Timer tick, asking Buildbucket for the build status
[14:34:14.273] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:34:14.273] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:136:0) after 1m0s
[14:35:14.298] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:136:0)
[14:35:14.298] Timer tick, asking Buildbucket for the build status
[14:35:14.439] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:35:14.440] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:137:0) after 1m0s
[14:36:14.487] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:137:0)
[14:36:14.487] Timer tick, asking Buildbucket for the build status
[14:36:14.612] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:36:14.612] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:138:0) after 1m0s
[14:37:14.632] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:138:0)
[14:37:14.632] Timer tick, asking Buildbucket for the build status
[14:37:14.746] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:37:14.746] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:139:0) after 1m0s
[14:38:14.843] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:139:0)
[14:38:14.843] Timer tick, asking Buildbucket for the build status
[14:38:14.884] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:38:14.884] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:140:0) after 1m0s
[14:39:14.907] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:140:0)
[14:39:14.907] Timer tick, asking Buildbucket for the build status
[14:39:14.969] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:39:14.969] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:141:0) after 1m0s
[14:40:14.991] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:141:0)
[14:40:14.991] Timer tick, asking Buildbucket for the build status
[14:40:15.231] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:40:15.231] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:142:0) after 1m0s
[14:41:15.260] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:142:0)
[14:41:15.260] Timer tick, asking Buildbucket for the build status
[14:41:15.304] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:41:15.304] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:143:0) after 1m0s
[14:42:15.327] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:143:0)
[14:42:15.327] Timer tick, asking Buildbucket for the build status
[14:42:15.415] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:42:15.415] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:144:0) after 1m0s
[14:43:15.456] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:144:0)
[14:43:15.456] Timer tick, asking Buildbucket for the build status
[14:43:15.489] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:43:15.489] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:145:0) after 1m0s
[14:44:15.513] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:145:0)
[14:44:15.513] Timer tick, asking Buildbucket for the build status
[14:44:15.569] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:44:15.569] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:146:0) after 1m0s
[14:45:15.596] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:146:0)
[14:45:15.596] Timer tick, asking Buildbucket for the build status
[14:45:15.657] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:45:15.657] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:147:0) after 1m0s
[14:46:15.700] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:147:0)
[14:46:15.700] Timer tick, asking Buildbucket for the build status
[14:46:15.843] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:46:15.843] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:148:0) after 1m0s
[14:47:15.867] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:148:0)
[14:47:15.867] Timer tick, asking Buildbucket for the build status
[14:47:16.017] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:47:16.017] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:149:0) after 1m0s
[14:48:16.039] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:149:0)
[14:48:16.039] Timer tick, asking Buildbucket for the build status
[14:48:16.131] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:48:16.131] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:150:0) after 1m0s
[14:49:16.154] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:150:0)
[14:49:16.154] Timer tick, asking Buildbucket for the build status
[14:49:16.211] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:49:16.211] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:151:0) after 1m0s
[14:50:16.345] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:151:0)
[14:50:16.345] Timer tick, asking Buildbucket for the build status
[14:50:16.456] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:50:16.456] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:152:0) after 1m0s
[14:51:16.483] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:152:0)
[14:51:16.483] Timer tick, asking Buildbucket for the build status
[14:51:16.538] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:51:16.539] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:153:0) after 1m0s
[14:52:16.782] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:153:0)
[14:52:16.782] Timer tick, asking Buildbucket for the build status
[14:52:16.932] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:52:16.932] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:154:0) after 1m0s
[14:53:16.959] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:154:0)
[14:53:16.959] Timer tick, asking Buildbucket for the build status
[14:53:17.050] Build 8932327971979171184: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:53:17.050] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9097758034200623680:155:0) after 1m0s
[14:54:04.285] Received PubSub notification, asking Buildbucket for the build status
[14:54:04.342] Build 8932327971979171184: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[14:54:04.342] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "AUTO",
"completed_ts": "1539874442766638",
"created_by": "user:luci-scheduler@appspot.gserviceaccount.com",
"created_ts": "1539865249614860",
"id": "8932327971979171184",
"parameters_json": "{\"builder_name\": \"Windows deterministic\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src.git\", \"revision\": \"43116fdd290fd13d324df39e20d3825f5851ca1a\"}}",
"project": "chromium",
"result": "SUCCESS",
"result_details_json": "{\"ui\": {\"info\": \"\"}, \"build_run_result\": {\"infraFailure\": null, \"recipeResult\": {\"jsonResult\": \"null\"}, \"recipeExitCode\": {\"value\": 0}, \"recipe\": {\"name\": \"swarming/deterministic_build\", \"repository\": \"\", \"revision\": \"\"}, \"annotationUrl\": \"logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8932327971979171184/+/annotations\"}, \"swarming\": {\"bot_dimensions\": {\"machine_type\": [\"n1-standard-8\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"], \"locale\": [\"en_US.cp1252\"], \"os\": [\"Windows\", \"Windows-10\", \"Windows-10-15063\"], \"builder\": [\"Windows deterministic\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Haswell_GCE\"], \"python\": [\"2.7.6\"], \"server_version\": [\"3809-a31bbe1\"], \"image\": [\"chrome-win10-1703-2018-04-20-61acaf8983f\"], \"gpu\": [\"none\"], \"cores\": [\"8\"], \"integrity\": [\"high\"], \"id\": [\"swarm2173-c4\"], \"pool\": [\"luci.chromium.ci\"], \"caches\": [\"git\", \"goma_v2\", \"vpython\"]}}, \"properties\": {\"got_nacl_revision\": \"99673869a3cd8731d924bd32fa486feebfdc6c4f\", \"got_swarming_client_revision\": \"486c9b53c4d54dd4b95bb6ce0e31160e600dfc11\", \"got_revision\": \"43116fdd290fd13d324df39e20d3825f5851ca1a\", \"recipe\": \"swarming/deterministic_build\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#25235}\", \"$recipe_engine/path\": {\"cache_dir\": \"C:\\\\b\\\\swarming\\\\w\\\\ir\\\\cache\", \"temp_dir\": \"C:\\\\b\\\\swarming\\\\w\\\\ir\\\\tmp\\\\rt\"}, \"got_revision_cp\": \"refs/heads/master@{#600735}\", \"branch\": \"refs/heads/master\", \"revision\": \"43116fdd290fd13d324df39e20d3825f5851ca1a\", \"repository\": \"https://chromium.googlesource.com/chromium/src.git\", \"buildername\": \"Windows deterministic\", \"got_webrtc_revision\": \"09beff2cfd84c3481b79a490414355fb1bf682e7\", \"mastername\": \"chromium.fyi\", \"got_angle_revision\": \"25843dd6518157dd84403d2a7f9c148e6723f852\", \"buildbucket\": {\"hostname\": \"cr-buildbucket.appspot.com\", \"build\": {\"created_ts\": 1539865249614860, \"tags\": [\"builder:Windows deterministic\", \"buildset:commit/git/43116fdd290fd13d324df39e20d3825f5851ca1a\", \"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/43116fdd290fd13d324df39e20d3825f5851ca1a\", \"gitiles_ref:refs/heads/master\", \"scheduler_invocation_id:9097758034200623680\", \"scheduler_job_id:chromium/Windows deterministic\", \"user_agent:luci-scheduler\"], \"bucket\": \"luci.chromium.ci\", \"created_by\": \"user:luci-scheduler@appspot.gserviceaccount.com\", \"project\": \"chromium\", \"id\": \"8932327971979171184\"}}, \"got_v8_revision\": \"bad9daf231f81a73da1b7b5a2a481892d92cc05c\", \"got_v8_revision_cp\": \"refs/heads/7.2.37@{#1}\", \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"buildnumber\": 10441, \"swarm_hashes\": {\"shell_dialogs_unittests\": \"42bc08b17e4f22218d59551796fc7180492234f9\", \"notification_helper_unittests\": \"a88bfaca47abda1ebcf3425f9acf755ad8670204\", \"gpu_perftests\": \"1e343c396670ca98727154de587b3767b98feaf1\", \"vr_common_unittests\": \"89fc31bc76622963764b919ce319d4605112b80d\", \"telemetry_unittests\": \"58f7ff70232d2dab563bd2677d31bd57e3d04621\", \"load_library_perf_tests\": \"0a06d8daaa452b00906096dda853297c2fc948e6\", \"devtools_closure_compile\": \"e42e665594c803fc6aac45d3b234e397034ef10a\", \"chromedriver_py_tests\": \"81b95c9ebda9dffb191f3be4dd5587d78ebe2a3f\", \"mojo_core_unittests\": \"9303443893fd610d8a06eb7b136f65e2a9ad19d5\", \"install_static_unittests\": \"70ff9e94ee909ecc7928516e5acd9a11880d4d02\", \"leveldb_service_unittests\": \"a3e5e5b6d0bbe7394f389165c6523a5ed68dd5c6\", \"mini_installer_tests\": \"549ae3b4c1289984cd04cbf6baeb96dffb0845a5\", \"gcp_unittests\": \"db6cd460b21eae94d7548514d03acde2ffecea24\", \"sbox_integration_tests\": \"4340bc9916a5255304c75dbaa2296a22ce3a889d\", \"angle_unittests\": \"7aace3cd54ebab6f205c4ea82125ea6fb04063c8\", \"cast_unittests\": \"716e55bea5c6df2673eafb37b861f57423ea3ac5\", \"cc_unittests\": \"716c2792ef35b0af1a5553bf8f95887edd5af52e\", \"blink_common_unittests\": \"d2764a3512e955a76b0817d451cd879c8fd31b3c\", \"crashpad_tests\": \"b9c69ca6c7ed7f8cf0a8ee18bf0e329b7620fe34\", \"telemetry_perf_tests_without_chrome\": \"dc2d3ecb7ed64bd44edf055a561b1d645fd2dd7f\", \"metrics_python_tests\": \"57ae1b2f18107bc36737c39c3d9a6a6fcc176218\", \"message_center_unittests\": \"cf322368003a4622ee38e291af689d9ac83ec393\", \"ppapi_unittests\": \"34c46da2960e4edd5c9c6e33d993776728fb6da7\", \"extensions_unittests\": \"11c1aee8ac12aecd4c879ff292f27863f8b3002d\", \"gl_unittests_ozone\": \"191b20cfbe9121d49976d93d0affdc61e153d3b8\", \"app_shell_unittests\": \"71b22807c7aae4d15d90681683dc026de1b7d95b\", \"chrome_app_unittests\": \"a82ca1a9432ebbc88df3ffe63e274ffe06cd6f95\", \"gl_unittests\": \"191b20cfbe9121d49976d93d0affdc61e153d3b8\", \"gcm_unit_tests\": \"ebaed3ad1125c75c72a10d32cd2c5b2b04350084\", \"views_unittests\": \"24f82b0fffe4a2769440ea82339ae6670458d36d\", \"content_shell_crash_test\": \"68237362b638d752a7611c81f0e7cbbbf6eb78f6\", \"ui_base_unittests\": \"a157b62043bd271e83d52e9c0150a1d862117ae0\", \"cronet_unittests\": \"ae187324c1b849a0935397c57520a725ca4210ee\", \"performance_test_suite\": \"9098a9ac87589517ff5b7cfd252e5f802d9ccc73\", \"wm_unittests\": \"cfdc4c5b574df922f3bf3a30a742750b1f19104f\", \"boringssl_crypto_tests\": \"d84013ba214eb42e30ba8c2862ef92b47ba811b1\", \"gin_unittests\": \"4bf40531d577e6b37c4c613130577cb72a69a426\", \"performance_browser_tests\": \"28ddf3b8b8f20fe94ac46960272f9f9f36c85f58\", \"extensions_browsertests\": \"40c065cf14547a9c75adf70bacadfe30f8fa5237\", \"webkit_python_tests\": \"19ee4990be6f9840899058e7ad44cc5e66fe2d63\", \"headless_unittests\": \"ad193942fc1c41098faeb2a04ea54e18d0e178d9\", \"webkit_layout_tests\": \"f6f827ba963569c778aac447305391ecf4ad8941\", \"vr_pixeltests\": \"b139b4a8e7e9bc0abec1ad35c06015590f47c1be\", \"setup_unittests\": \"3a1032bc78151e2c59c7ecdd5a31f57c9c91fa60\", \"webkit_unit_tests\": \"e87d15670fead37fd5bb3852a91a2e182c2c1ce9\", \"content_unittests\": \"5d927eb64a898a549ed9ef704b360a53fc8c08ee\", \"performance_webview_test_suite\": \"0a09f1bebd1a12af95fb083f03c112ff0458b9e1\", \"wtf_unittests\": \"a302326d1302a1295b7d0f77d9ff0924e0d7cb27\", \"webkit_layout_tests_exparchive\": \"2c896228e55787092bf51cbb10e47ad51ff23bc1\", \"chrome_cleaner_unittests\": \"eb6b01839f1a3d1e48e4024ae14c020cc5c51e2e\", \"traffic_annotation_auditor_unittests\": \"909deb4daaedec4ccefb3cfc89d3a742e5c1ef0a\", \"libjingle_xmpp_unittests\": \"245f9f5c45f3bfbf20b33bf66761a5e4a03b2a88\", \"remoting_unittests\": \"d5db117b5b5d514ed441ccb85ae5385fd7860e98\", \"vr_common_perftests\": \"dc6e1f77a286a55a0dba0442bc2de4aee545eaed\", \"filesystem_service_unittests\": \"37c7fd2360c92a97e875b60e9f7f98830c51aed8\", \"chrome_elf_import_unittests\": \"2c7d6cf22f9f0e0b2efbc32def130f585c4a8a7d\", \"installer_util_unittests\": \"587f8f5108fcd3c29018da00fc593f5e213f0f37\", \"gfx_unittests\": \"1b4d2f7a139c095804d7468019a2e49f2aff56e6\", \"headless_browsertests\": \"2b762164798814cc870e22f364c62bbdb679d4a2\", \"capture_unittests\": \"95c1183f9f491c02522f9b6a12d2d2f33e382406\", \"chrome_elf_unittests\": \"4fc5ee4b3977eb8bcc60999a9dd57a9da66ac49f\", \"telemetry_gpu_unittests\": \"65fff5f37827a2ba1a4340868cdd0937b5ae8a39\", \"command_buffer_perftests\": \"06802a06974f7a340628a24ccb82cff805c30c9f\", \"media_unittests\": \"6a09414eb78befd5872543542b820f5cb563e31c\", \"chromedriver_unittests\": \"9a96a879816871712302d8972996fea6004c0f4a\", \"views_mus_interactive_ui_tests\": \"845346c79c8e2f0120a4a6b752707d5393d7e158\", \"storage_unittests\": \"3dcb3bfd0e52f6eed210ef03f9a8c5dd0ca63d1b\", \"media_service_unittests\": \"6caa281566ad715cede6e05ac95b38d28fbfdb26\", \"compositor_unittests\": \"011df7fea8657d7e1c9f37e77678249bf6cf6669\", \"latency_unittests\": \"036506b4b5f48f6116eea9422caeda5c6efcde65\", \"video_decode_accelerator_unittest\": \"64cbbbd3122223711f76a0ce2aed864242639bed\", \"swiftshader_unittests\": \"c6e9118d25da1823b5e69a967ae7967da880c394\", \"telemetry_perf_unittests\": \"9c4f0d0fce64cadecef5c6aa69387e378028d688\", \"media_blink_unittests\": \"d960ef8c7f863e7e528796781530d2ba52a7bca5\", \"views_mus_unittests\": \"1cf044817245d4b7ea2ec19c4be721b2920e9d4b\", \"components_unittests\": \"09e19ab2022c8240a8f9793f1d3d212933f83499\", \"snapshot_unittests\": \"f5807c0e497a64333d444b40c268446c26d9a40f\", \"accessibility_unittests\": \"0d0678a4ff06abc1beedc6e6b417ece61d6cbbf5\", \"net_perftests\": \"dec2ce6b1ca4c09aa40d1a816d08e816b3972c7b\", \"aura_unittests\": \"d46d616dbdb6877bcb9d200290599b645dcbc588\", \"services_unittests\": \"a41f285249f5616120d2e0ba31686bbdf2959e55\", \"components_perftests\": \"e2ab94731fb148652f6510eadec08e05c927f39d\", \"events_unittests\": \"1c8e5e1bc1cda35a3df915204b57ce4ac88de632\", \"tracing_perftests\": \"3e02b3021afa4870b064c185bc767baa065fc836\", \"chromedriver_replay_unittests\": \"5013a0f078eac50a549885e896698d163bf73605\", \"ui_touch_selection_unittests\": \"e32118dcda9c99ac42cb4173a206a8c358249200\", \"cacheinvalidation_unittests\": \"f9922a69efcf0a00f9faab1645508b0b7a937cb0\", \"viz_unittests\": \"59570249e9c921b2d7ca74be21e809176ce115e7\", \"browser_tests\": \"152873df178eecd36b85a790b01f6a15078c38d3\", \"net_unittests\": \"b7a0a7c5d4d4d09d2a570c5d305806b28c970983\", \"pdf_unittests\": \"0b4e800e5e13eeab1e37acff88c0e2bc0afd2d72\", \"boringssl_ssl_tests\": \"c3df63033489ed29f3f6e561c2407e526bfbc0ce\", \"sbox_validation_tests\": \"45885d50f44818eb83aa6645e55a20adfb6c0726\", \"elevation_service_unittests\": \"4881abcdf724e40fec2c446c9933191129e9e011\", \"gpu_unittests\": \"8b21b1d12e00dbf20686469dd1ce4ffceff5a67a\", \"native_theme_unittests\": \"502cd32600014aea88448c73b4d9192bf06343db\", \"interactive_ui_tests\": \"d4493c1629df246fc9b0de41503ec96684ab9a28\", \"mojo_unittests\": \"92a8e781c6153c42008366a23e4719878bc755ad\", \"url_unittests\": \"d5c5422f093e7fbf5c7df44564dbad64dcda0340\", \"media_perftests\": \"4f57b91adb62d5de13821e89e2a5634acd7c9d2f\", \"cronet_tests\": \"0e6c5bccdeb99ea32f875ccad0e3772fe4001e3c\", \"google_apis_unittests\": \"a4f53b260cc2494a77d78bd6d32fa51dabe567e4\", \"telemetry_gpu_integration_test\": \"13e4b8252780d35d7aa78820086a5e11cd75981b\", \"blink_heap_unittests\": \"7ced91dcce2c7e6c326298ba50f1ed4672bf0b65\", \"midi_unittests\": \"50f889b6558aeef0cf4031f6e1115a45d2fea407\", \"base_unittests\": \"9f41167f8294a2200049d0aaa69afbbda289a414\", \"sync_integration_tests\": \"6734e2dc01641925cd0a8f24b8a293b746119bbd\", \"sql_unittests\": \"3a3fd95029031885ec1430340d1821f17a7b3303\", \"courgette_unittests\": \"50304ef7cae3ac604fa2c3ad6bc191cc18b03a6c\", \"blink_fuzzer_unittests\": \"373709472ffa3c9e4efd5f70110ccd66dd56f4b4\", \"gl_tests\": \"d59cb5f34ff9f5fbdd49068e1fa09eddb4776828\", \"zucchini_unittests\": \"b0ce40fd61700ac63bf85969207e6d7c5104bcf1\", \"ipc_tests\": \"43d08e2a7b7aa10f73515d44c100ff28bb6f1c74\", \"angle_end2end_tests\": \"b6f780371a6d95f86490b6419422f1ed0f1c74a0\", \"blink_platform_unittests\": \"c581e51172cfd05c7be9f22ec5d1d6904649a0f9\", \"components_browsertests\": \"6b1b5f1b5d0a930f20471e2e1c19c7a6f84ffeca\", \"views_perftests\": \"b5b1b9d4353b132ecafa2a4a94da4ef1bf3b287c\", \"angle_perftests\": \"2a0a2eab655c0be67a5b3067143e2cc850b4bd73\", \"display_unittests\": \"df3eb8cd7b0fb9ac8dfae4b8d79afb62b25a6bea\", \"sbox_unittests\": \"025b614d93e595b616cf1e51d55059ee872a8d83\", \"service_manager_unittests\": \"8181cf459d2e4306cce762266ea871ee02151ad0\", \"gles2_conform_test\": \"bcc98c763284f9e002761796c92c863723c96c40\", \"jingle_unittests\": \"6836ec0ab9e1522c68388e5f13795fecae5621c6\", \"skia_unittests\": \"1e7acb73804ca2362dc5329c6f242c5f254d2017\", \"angle_white_box_tests\": \"b6adcf9b284f246d9922c4d1a2a830b09f586533\", \"crypto_unittests\": \"db113d8a5fac4ce9956e9b793ee2fafa8d983668\", \"nacl_loader_unittests\": \"ec2f7864eaf59dc20e1c4ef4281dc5b83bee6a75\", \"unit_tests\": \"42baba8e68016f651dcaa8d51d8fbdac4e12616c\", \"content_browsertests\": \"96769fc6c8b40f924a31c2722ffa58f7a1e45b6c\", \"printing_unittests\": \"26e3e8194b187080615396b450bde17e4fdb260e\", \"device_unittests\": \"ed61dc4c2b24741aad485e203b4ff09a8449c7a1\"}, \"path_config\": \"generic\", \"bot_id\": \"swarm2173-c4\", \"got_buildtools_revision\": \"13a00f110ef910a25763346d6538b60f12845656\"}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1539865252774627",
"status": "COMPLETED",
"status_changed_ts": "1539874443565252",
"tags": [
"build_address:luci.chromium.ci/Windows deterministic/10441",
"builder:Windows deterministic",
"buildset:commit/git/43116fdd290fd13d324df39e20d3825f5851ca1a",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/43116fdd290fd13d324df39e20d3825f5851ca1a",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9097758034200623680",
"scheduler_job_id:chromium/Windows deterministic",
"swarming_dimension:builder:Windows deterministic",
"swarming_dimension:caches:builder_d795d6e07fe37a299fcfc0e872e48757ad306282f024125f803c0465bfd1eeae_v2",
"swarming_dimension:cores:8",
"swarming_dimension:cpu:x86-64",
"swarming_dimension:os:Windows-10",
"swarming_dimension:pool:luci.chromium.ci",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:build_address:luci.chromium.ci/Windows deterministic/10441",
"swarming_tag:buildbucket_bucket:luci.chromium.ci",
"swarming_tag:buildbucket_build_id:8932327971979171184",
"swarming_tag:buildbucket_hostname:cr-buildbucket.appspot.com",
"swarming_tag:buildbucket_template_canary:0",
"swarming_tag:buildbucket_template_revision:124eed49d11e136feabd3af4ed5694849cf76783",
"swarming_tag:builder:Windows deterministic",
"swarming_tag:buildset:commit/git/43116fdd290fd13d324df39e20d3825f5851ca1a",
"swarming_tag:buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/43116fdd290fd13d324df39e20d3825f5851ca1a",
"swarming_tag:caches:builder_d795d6e07fe37a299fcfc0e872e48757ad306282f024125f803c0465bfd1eeae_v2",
"swarming_tag:cores:8",
"swarming_tag:cpu:x86-64",
"swarming_tag:gitiles_ref:refs/heads/master",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8932327971979171184/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:os:Windows-10",
"swarming_tag:pool:luci.chromium.ci",
"swarming_tag:priority:30",
"swarming_tag:recipe_name:swarming/deterministic_build",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_tag:scheduler_invocation_id:9097758034200623680",
"swarming_tag:scheduler_job_id:chromium/Windows deterministic",
"swarming_tag:service_account:chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"swarming_tag:swarming.pool.template:skip",
"swarming_tag:swarming.pool.version:16d89b69cb6383fd143444068fba8510114d6c27",
"swarming_tag:user:None",
"swarming_tag:user_agent:luci-scheduler",
"swarming_tag:vpython:native-python-wrapper",
"swarming_task_id:409ff09257c62510",
"user_agent:luci-scheduler"
],
"updated_ts": "1539874443567250",
"url": "https://ci.chromium.org/p/chromium/builders/luci.chromium.ci/Windows deterministic/10441",
"utcnow_ts": "1539874444325213"
}
}
[14:54:04.342] Invocation finished in 2h33m16.230511328s with status SUCCEEDED