[05:19:00.090] New invocation is queued and will start shortly
[05:19:01.183] Starting the invocation (attempt 1)
[05:19:01.228] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[05:19:01.228] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[05:19:01.229] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9065441454603257632",
"parameters_json": "{\"builder_name\":\"Windows deterministic\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"7e9c5d4e6befce7aef7679bc40e9cda611d61cd9\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:Windows deterministic",
"scheduler_invocation_id:9065441454603257632",
"scheduler_job_id:chromium/Windows deterministic",
"user_agent:luci-scheduler",
"buildset:commit/git/7e9c5d4e6befce7aef7679bc40e9cda611d61cd9",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/7e9c5d4e6befce7aef7679bc40e9cda611d61cd9",
"gitiles_ref:refs/heads/master"
]
}
[05:19:02.258] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1570684741417665",
"id": "8900011392542083872",
"parameters_json": "{\"builder_name\": \"Windows deterministic\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"7e9c5d4e6befce7aef7679bc40e9cda611d61cd9\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1570684742063050",
"tags": [
"build_address:luci.chromium.ci/Windows deterministic/14933",
"builder:Windows deterministic",
"buildset:commit/git/7e9c5d4e6befce7aef7679bc40e9cda611d61cd9",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/7e9c5d4e6befce7aef7679bc40e9cda611d61cd9",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9065441454603257632",
"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/8900011392542083872/+/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": "1570684742063196",
"url": "https://ci.chromium.org/b/8900011392542083872",
"utcnow_ts": "1570684742247643"
}
}
[05:19:02.258] Task URL: https://ci.chromium.org/b/8900011392542083872
[05:19:02.258] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:2:0) after 1m0s
[05:20:02.382] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:2:0)
[05:20:02.382] Timer tick, asking Buildbucket for the build status
[05:20:03.439] Build 8900011392542083872: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:20:03.439] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:3:0) after 1m0s
[05:21:03.518] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:3:0)
[05:21:03.518] Timer tick, asking Buildbucket for the build status
[05:21:03.983] Build 8900011392542083872: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:21:03.983] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:4:0) after 1m0s
[05:21:10.655] Received PubSub notification, asking Buildbucket for the build status
[05:21:12.936] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:22:04.057] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:4:0)
[05:22:04.057] Timer tick, asking Buildbucket for the build status
[05:22:04.475] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:22:04.475] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:6:0) after 1m0s
[05:23:04.575] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:6:0)
[05:23:04.575] Timer tick, asking Buildbucket for the build status
[05:23:04.787] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:23:04.787] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:7:0) after 1m0s
[05:24:04.912] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:7:0)
[05:24:04.912] Timer tick, asking Buildbucket for the build status
[05:24:05.699] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:24:05.699] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:8:0) after 1m0s
[05:25:05.758] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:8:0)
[05:25:05.758] Timer tick, asking Buildbucket for the build status
[05:25:06.523] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:25:06.523] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:9:0) after 1m0s
[05:26:06.593] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:9:0)
[05:26:06.593] Timer tick, asking Buildbucket for the build status
[05:26:07.559] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:26:07.559] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:10:0) after 1m0s
[05:27:07.598] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:10:0)
[05:27:07.598] Timer tick, asking Buildbucket for the build status
[05:27:08.141] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:27:08.141] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:11:0) after 1m0s
[05:28:08.213] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:11:0)
[05:28:08.213] Timer tick, asking Buildbucket for the build status
[05:28:08.964] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:28:08.964] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:12:0) after 1m0s
[05:29:09.024] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:12:0)
[05:29:09.024] Timer tick, asking Buildbucket for the build status
[05:29:09.278] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:29:09.278] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:13:0) after 1m0s
[05:30:09.388] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:13:0)
[05:30:09.388] Timer tick, asking Buildbucket for the build status
[05:30:09.618] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:30:09.618] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:14:0) after 1m0s
[05:31:09.668] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:14:0)
[05:31:09.668] Timer tick, asking Buildbucket for the build status
[05:31:09.888] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:31:09.888] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:15:0) after 1m0s
[05:32:09.924] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:15:0)
[05:32:09.924] Timer tick, asking Buildbucket for the build status
[05:32:11.445] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:32:11.445] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:16:0) after 1m0s
[05:33:11.479] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:16:0)
[05:33:11.479] Timer tick, asking Buildbucket for the build status
[05:33:11.757] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:33:11.757] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:17:0) after 1m0s
[05:34:11.816] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:17:0)
[05:34:11.816] Timer tick, asking Buildbucket for the build status
[05:34:12.266] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:34:12.266] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:18:0) after 1m0s
[05:35:12.297] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:18:0)
[05:35:12.297] Timer tick, asking Buildbucket for the build status
[05:35:12.588] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:35:12.588] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:19:0) after 1m0s
[05:36:12.625] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:19:0)
[05:36:12.625] Timer tick, asking Buildbucket for the build status
[05:36:13.685] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:36:13.685] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:20:0) after 1m0s
[05:37:13.747] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:20:0)
[05:37:13.747] Timer tick, asking Buildbucket for the build status
[05:37:13.925] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:37:13.925] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:21:0) after 1m0s
[05:38:13.956] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:21:0)
[05:38:13.956] Timer tick, asking Buildbucket for the build status
[05:38:14.973] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:38:14.973] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:22:0) after 1m0s
[05:39:15.138] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:22:0)
[05:39:15.138] Timer tick, asking Buildbucket for the build status
[05:39:15.738] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:39:15.738] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:23:0) after 1m0s
[05:40:15.780] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:23:0)
[05:40:15.781] Timer tick, asking Buildbucket for the build status
[05:40:18.433] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:40:18.433] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:24:0) after 1m0s
[05:41:18.584] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:24:0)
[05:41:18.584] Timer tick, asking Buildbucket for the build status
[05:41:18.941] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:41:18.941] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:25:0) after 1m0s
[05:42:19.031] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:25:0)
[05:42:19.031] Timer tick, asking Buildbucket for the build status
[05:42:21.623] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:42:21.623] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:26:0) after 1m0s
[05:43:21.663] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:26:0)
[05:43:21.663] Timer tick, asking Buildbucket for the build status
[05:43:21.897] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:43:21.897] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:27:0) after 1m0s
[05:44:22.053] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:27:0)
[05:44:22.053] Timer tick, asking Buildbucket for the build status
[05:44:23.736] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:44:23.736] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:28:0) after 1m0s
[05:45:23.800] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:28:0)
[05:45:23.800] Timer tick, asking Buildbucket for the build status
[05:45:24.050] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:45:24.050] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:29:0) after 1m0s
[05:46:24.084] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:29:0)
[05:46:24.084] Timer tick, asking Buildbucket for the build status
[05:46:24.711] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:46:24.711] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:30:0) after 1m0s
[05:47:24.759] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:30:0)
[05:47:24.759] Timer tick, asking Buildbucket for the build status
[05:47:25.286] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:47:25.286] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:31:0) after 1m0s
[05:48:25.535] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:31:0)
[05:48:25.535] Timer tick, asking Buildbucket for the build status
[05:48:25.735] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:48:25.735] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:32:0) after 1m0s
[05:49:25.832] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:32:0)
[05:49:25.832] Timer tick, asking Buildbucket for the build status
[05:49:26.032] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:49:26.032] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:33:0) after 1m0s
[05:50:26.214] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:33:0)
[05:50:26.214] Timer tick, asking Buildbucket for the build status
[05:50:27.136] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:50:27.136] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:34:0) after 1m0s
[05:51:27.203] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:34:0)
[05:51:27.203] Timer tick, asking Buildbucket for the build status
[05:51:28.398] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:51:28.398] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:35:0) after 1m0s
[05:52:28.529] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:35:0)
[05:52:28.529] Timer tick, asking Buildbucket for the build status
[05:52:31.057] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:52:31.057] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:36:0) after 1m0s
[05:53:31.171] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:36:0)
[05:53:31.171] Timer tick, asking Buildbucket for the build status
[05:53:32.045] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:53:32.045] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:37:0) after 1m0s
[05:54:32.112] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:37:0)
[05:54:32.112] Timer tick, asking Buildbucket for the build status
[05:54:32.378] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:54:32.378] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:38:0) after 1m0s
[05:55:32.471] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:38:0)
[05:55:32.471] Timer tick, asking Buildbucket for the build status
[05:55:32.836] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:55:32.836] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:39:0) after 1m0s
[05:56:32.843] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:39:0)
[05:56:32.843] Timer tick, asking Buildbucket for the build status
[05:56:33.432] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:56:33.432] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:40:0) after 1m0s
[05:57:33.421] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:40:0)
[05:57:33.421] Timer tick, asking Buildbucket for the build status
[05:57:36.548] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:57:36.548] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:41:0) after 1m0s
[05:58:36.608] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:41:0)
[05:58:36.608] Timer tick, asking Buildbucket for the build status
[05:58:37.336] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:58:37.336] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:42:0) after 1m0s
[05:59:37.361] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:42:0)
[05:59:37.361] Timer tick, asking Buildbucket for the build status
[05:59:37.567] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:59:37.567] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:43:0) after 1m0s
[06:00:37.576] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:43:0)
[06:00:37.576] Timer tick, asking Buildbucket for the build status
[06:00:37.855] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:00:37.855] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:44:0) after 1m0s
[06:01:37.936] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:44:0)
[06:01:37.936] Timer tick, asking Buildbucket for the build status
[06:01:38.392] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:01:38.393] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:45:0) after 1m0s
[06:02:38.417] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:45:0)
[06:02:38.417] Timer tick, asking Buildbucket for the build status
[06:02:39.530] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:02:39.530] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:46:0) after 1m0s
[06:03:39.600] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:46:0)
[06:03:39.600] Timer tick, asking Buildbucket for the build status
[06:03:41.954] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:03:41.956] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:47:0) after 1m0s
[06:04:41.980] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:47:0)
[06:04:41.980] Timer tick, asking Buildbucket for the build status
[06:04:42.595] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:04:42.595] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:48:0) after 1m0s
[06:05:42.679] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:48:0)
[06:05:42.679] Timer tick, asking Buildbucket for the build status
[06:05:46.959] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:05:46.959] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:49:0) after 1m0s
[06:06:46.982] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:49:0)
[06:06:46.982] Timer tick, asking Buildbucket for the build status
[06:06:51.254] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:06:51.254] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:50:0) after 1m0s
[06:07:51.271] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:50:0)
[06:07:51.271] Timer tick, asking Buildbucket for the build status
[06:07:51.508] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:07:51.508] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:51:0) after 1m0s
[06:08:51.627] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:51:0)
[06:08:51.627] Timer tick, asking Buildbucket for the build status
[06:08:54.322] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:08:54.322] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:52:0) after 1m0s
[06:09:54.362] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:52:0)
[06:09:54.362] Timer tick, asking Buildbucket for the build status
[06:09:54.579] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:09:54.580] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:53:0) after 1m0s
[06:10:54.616] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:53:0)
[06:10:54.616] Timer tick, asking Buildbucket for the build status
[06:10:55.682] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:10:55.682] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:54:0) after 1m0s
[06:11:55.773] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:54:0)
[06:11:55.773] Timer tick, asking Buildbucket for the build status
[06:11:57.518] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:11:57.518] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:55:0) after 1m0s
[06:12:57.534] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:55:0)
[06:12:57.534] Timer tick, asking Buildbucket for the build status
[06:12:57.952] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:12:57.952] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:56:0) after 1m0s
[06:13:57.987] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:56:0)
[06:13:57.987] Timer tick, asking Buildbucket for the build status
[06:13:58.321] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:13:58.321] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:57:0) after 1m0s
[06:14:58.482] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:57:0)
[06:14:58.482] Timer tick, asking Buildbucket for the build status
[06:14:58.769] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:14:58.769] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:58:0) after 1m0s
[06:15:58.871] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:58:0)
[06:15:58.871] Timer tick, asking Buildbucket for the build status
[06:15:59.705] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:15:59.705] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:59:0) after 1m0s
[06:16:59.777] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:59:0)
[06:16:59.777] Timer tick, asking Buildbucket for the build status
[06:17:00.163] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:17:00.163] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:60:0) after 1m0s
[06:18:00.183] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:60:0)
[06:18:00.183] Timer tick, asking Buildbucket for the build status
[06:18:01.032] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:18:01.032] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:61:0) after 1m0s
[06:19:01.098] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:61:0)
[06:19:01.098] Timer tick, asking Buildbucket for the build status
[06:19:01.336] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:19:01.336] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:62:0) after 1m0s
[06:20:01.401] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:62:0)
[06:20:01.401] Timer tick, asking Buildbucket for the build status
[06:20:01.634] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:20:01.634] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:63:0) after 1m0s
[06:21:01.777] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:63:0)
[06:21:01.777] Timer tick, asking Buildbucket for the build status
[06:21:01.940] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:21:01.940] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:64:0) after 1m0s
[06:22:02.035] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:64:0)
[06:22:02.035] Timer tick, asking Buildbucket for the build status
[06:22:02.317] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:22:02.317] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:65:0) after 1m0s
[06:23:02.490] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:65:0)
[06:23:02.490] Timer tick, asking Buildbucket for the build status
[06:23:03.237] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:23:03.237] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:66:0) after 1m0s
[06:24:03.404] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:66:0)
[06:24:03.404] Timer tick, asking Buildbucket for the build status
[06:24:03.853] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:24:03.853] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:67:0) after 1m0s
[06:25:03.900] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:67:0)
[06:25:03.900] Timer tick, asking Buildbucket for the build status
[06:25:04.180] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:25:04.180] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:68:0) after 1m0s
[06:26:04.229] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:68:0)
[06:26:04.229] Timer tick, asking Buildbucket for the build status
[06:26:04.830] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:26:04.830] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:69:0) after 1m0s
[06:27:04.861] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:69:0)
[06:27:04.861] Timer tick, asking Buildbucket for the build status
[06:27:07.459] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:27:07.459] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:70:0) after 1m0s
[06:28:07.579] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:70:0)
[06:28:07.579] Timer tick, asking Buildbucket for the build status
[06:28:07.895] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:28:07.895] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:71:0) after 1m0s
[06:29:07.913] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:71:0)
[06:29:07.913] Timer tick, asking Buildbucket for the build status
[06:29:08.221] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:29:08.221] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:72:0) after 1m0s
[06:30:08.292] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:72:0)
[06:30:08.292] Timer tick, asking Buildbucket for the build status
[06:30:09.011] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:30:09.011] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:73:0) after 1m0s
[06:31:09.059] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:73:0)
[06:31:09.059] Timer tick, asking Buildbucket for the build status
[06:31:09.796] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:31:09.796] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:74:0) after 1m0s
[06:32:09.828] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:74:0)
[06:32:09.829] Timer tick, asking Buildbucket for the build status
[06:32:10.454] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:32:10.454] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:75:0) after 1m0s
[06:33:10.531] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:75:0)
[06:33:10.531] Timer tick, asking Buildbucket for the build status
[06:33:10.764] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:33:10.764] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:76:0) after 1m0s
[06:34:10.833] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:76:0)
[06:34:10.833] Timer tick, asking Buildbucket for the build status
[06:34:11.053] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:34:11.053] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:77:0) after 1m0s
[06:35:11.139] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:77:0)
[06:35:11.139] Timer tick, asking Buildbucket for the build status
[06:35:12.230] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:35:12.230] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:78:0) after 1m0s
[06:36:12.325] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:78:0)
[06:36:12.325] Timer tick, asking Buildbucket for the build status
[06:36:12.570] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:36:12.570] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:79:0) after 1m0s
[06:37:12.601] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:79:0)
[06:37:12.601] Timer tick, asking Buildbucket for the build status
[06:37:14.142] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:37:14.142] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:80:0) after 1m0s
[06:38:14.234] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:80:0)
[06:38:14.234] Timer tick, asking Buildbucket for the build status
[06:38:14.797] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:38:14.797] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:81:0) after 1m0s
[06:39:14.860] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:81:0)
[06:39:14.860] Timer tick, asking Buildbucket for the build status
[06:39:16.846] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:39:16.846] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:82:0) after 1m0s
[06:40:17.028] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:82:0)
[06:40:17.028] Timer tick, asking Buildbucket for the build status
[06:40:19.209] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:40:19.209] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:83:0) after 1m0s
[06:41:19.304] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:83:0)
[06:41:19.304] Timer tick, asking Buildbucket for the build status
[06:41:19.543] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:41:19.543] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:84:0) after 1m0s
[06:42:19.768] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:84:0)
[06:42:19.768] Timer tick, asking Buildbucket for the build status
[06:42:22.306] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:42:22.306] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:85:0) after 1m0s
[06:43:22.355] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:85:0)
[06:43:22.355] Timer tick, asking Buildbucket for the build status
[06:43:22.883] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:43:22.883] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:86:0) after 1m0s
[06:44:23.028] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:86:0)
[06:44:23.028] Timer tick, asking Buildbucket for the build status
[06:44:23.505] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:44:23.505] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:87:0) after 1m0s
[06:45:23.555] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:87:0)
[06:45:23.555] Timer tick, asking Buildbucket for the build status
[06:45:24.563] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:45:24.563] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:88:0) after 1m0s
[06:46:24.762] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:88:0)
[06:46:24.762] Timer tick, asking Buildbucket for the build status
[06:46:25.177] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:46:25.177] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:89:0) after 1m0s
[06:47:25.442] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:89:0)
[06:47:25.442] Timer tick, asking Buildbucket for the build status
[06:47:26.034] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:47:26.034] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:90:0) after 1m0s
[06:48:26.179] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:90:0)
[06:48:26.179] Timer tick, asking Buildbucket for the build status
[06:48:26.427] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:48:26.427] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:91:0) after 1m0s
[06:49:26.487] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:91:0)
[06:49:26.487] Timer tick, asking Buildbucket for the build status
[06:49:26.819] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:49:26.819] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:92:0) after 1m0s
[06:50:26.917] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:92:0)
[06:50:26.917] Timer tick, asking Buildbucket for the build status
[06:50:27.376] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:50:27.376] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:93:0) after 1m0s
[06:51:27.471] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:93:0)
[06:51:27.471] Timer tick, asking Buildbucket for the build status
[06:51:27.651] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:51:27.651] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:94:0) after 1m0s
[06:52:27.779] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:94:0)
[06:52:27.779] Timer tick, asking Buildbucket for the build status
[06:52:30.733] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:52:30.733] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:95:0) after 1m0s
[06:53:31.135] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:95:0)
[06:53:31.135] Timer tick, asking Buildbucket for the build status
[06:53:31.621] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:53:31.621] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:96:0) after 1m0s
[06:54:31.821] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:96:0)
[06:54:31.821] Timer tick, asking Buildbucket for the build status
[06:54:32.027] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:54:32.027] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:97:0) after 1m0s
[06:55:32.073] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:97:0)
[06:55:32.074] Timer tick, asking Buildbucket for the build status
[06:55:32.395] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:55:32.395] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:98:0) after 1m0s
[06:56:32.489] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:98:0)
[06:56:32.489] Timer tick, asking Buildbucket for the build status
[06:56:33.236] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:56:33.236] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:99:0) after 1m0s
[06:57:33.277] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:99:0)
[06:57:33.277] Timer tick, asking Buildbucket for the build status
[06:57:33.560] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:57:33.560] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:100:0) after 1m0s
[06:58:33.596] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:100:0)
[06:58:33.596] Timer tick, asking Buildbucket for the build status
[06:58:34.044] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:58:34.044] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:101:0) after 1m0s
[06:59:34.262] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:101:0)
[06:59:34.262] Timer tick, asking Buildbucket for the build status
[06:59:34.941] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:59:34.941] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:102:0) after 1m0s
[07:00:35.054] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:102:0)
[07:00:35.054] Timer tick, asking Buildbucket for the build status
[07:00:41.169] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:00:41.169] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:103:0) after 1m0s
[07:01:41.257] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:103:0)
[07:01:41.257] Timer tick, asking Buildbucket for the build status
[07:01:41.980] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:01:41.980] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:104:0) after 1m0s
[07:02:42.174] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:104:0)
[07:02:42.174] Timer tick, asking Buildbucket for the build status
[07:02:42.835] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:02:42.836] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:105:0) after 1m0s
[07:03:43.202] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:105:0)
[07:03:43.202] Timer tick, asking Buildbucket for the build status
[07:03:44.162] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:03:44.162] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:106:0) after 1m0s
[07:04:44.218] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:106:0)
[07:04:44.218] Timer tick, asking Buildbucket for the build status
[07:04:47.507] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:04:47.507] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:107:0) after 1m0s
[07:05:47.544] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:107:0)
[07:05:47.544] Timer tick, asking Buildbucket for the build status
[07:05:47.820] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:05:47.820] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:108:0) after 1m0s
[07:06:47.998] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:108:0)
[07:06:47.998] Timer tick, asking Buildbucket for the build status
[07:06:50.376] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:06:50.376] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:109:0) after 1m0s
[07:07:50.412] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:109:0)
[07:07:50.412] Timer tick, asking Buildbucket for the build status
[07:07:51.700] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:07:51.700] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:110:0) after 1m0s
[07:08:51.742] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:110:0)
[07:08:51.742] Timer tick, asking Buildbucket for the build status
[07:08:52.204] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:08:52.204] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:111:0) after 1m0s
[07:09:52.331] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:111:0)
[07:09:52.331] Timer tick, asking Buildbucket for the build status
[07:09:54.380] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:09:54.380] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:112:0) after 1m0s
[07:10:54.564] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:112:0)
[07:10:54.564] Timer tick, asking Buildbucket for the build status
[07:10:55.190] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:10:55.190] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:113:0) after 1m0s
[07:11:55.315] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:113:0)
[07:11:55.315] Timer tick, asking Buildbucket for the build status
[07:11:58.005] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:11:58.005] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:114:0) after 1m0s
[07:12:58.083] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:114:0)
[07:12:58.083] Timer tick, asking Buildbucket for the build status
[07:13:02.795] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:13:02.795] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:115:0) after 1m0s
[07:14:03.007] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:115:0)
[07:14:03.007] Timer tick, asking Buildbucket for the build status
[07:14:03.174] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:14:03.174] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:116:0) after 1m0s
[07:15:03.294] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:116:0)
[07:15:03.294] Timer tick, asking Buildbucket for the build status
[07:15:03.491] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:15:03.491] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:117:0) after 1m0s
[07:16:03.540] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:117:0)
[07:16:03.540] Timer tick, asking Buildbucket for the build status
[07:16:04.419] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:16:04.419] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:118:0) after 1m0s
[07:17:04.506] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:118:0)
[07:17:04.506] Timer tick, asking Buildbucket for the build status
[07:17:04.928] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:17:04.928] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:119:0) after 1m0s
[07:18:05.129] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:119:0)
[07:18:05.130] Timer tick, asking Buildbucket for the build status
[07:18:10.717] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:18:10.717] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:120:0) after 1m0s
[07:19:10.849] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:120:0)
[07:19:10.849] Timer tick, asking Buildbucket for the build status
[07:19:12.007] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:19:12.007] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:121:0) after 1m0s
[07:20:12.073] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:121:0)
[07:20:12.073] Timer tick, asking Buildbucket for the build status
[07:20:12.803] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:20:12.803] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:122:0) after 1m0s
[07:21:12.885] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:122:0)
[07:21:12.885] Timer tick, asking Buildbucket for the build status
[07:21:13.087] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:21:13.087] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:123:0) after 1m0s
[07:22:13.138] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:123:0)
[07:22:13.138] Timer tick, asking Buildbucket for the build status
[07:22:13.575] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:22:13.575] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:124:0) after 1m0s
[07:23:13.643] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:124:0)
[07:23:13.643] Timer tick, asking Buildbucket for the build status
[07:23:14.497] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:23:14.497] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:125:0) after 1m0s
[07:24:14.529] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:125:0)
[07:24:14.529] Timer tick, asking Buildbucket for the build status
[07:24:15.426] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:24:15.426] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:126:0) after 1m0s
[07:25:15.511] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:126:0)
[07:25:15.511] Timer tick, asking Buildbucket for the build status
[07:25:16.164] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:25:16.164] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:127:0) after 1m0s
[07:26:16.174] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:127:0)
[07:26:16.174] Timer tick, asking Buildbucket for the build status
[07:26:16.457] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:26:16.457] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:128:0) after 1m0s
[07:27:16.480] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:128:0)
[07:27:16.480] Timer tick, asking Buildbucket for the build status
[07:27:16.723] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:27:16.723] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:129:0) after 1m0s
[07:28:16.766] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:129:0)
[07:28:16.766] Timer tick, asking Buildbucket for the build status
[07:28:17.477] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:28:17.477] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:130:0) after 1m0s
[07:29:17.551] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:130:0)
[07:29:17.551] Timer tick, asking Buildbucket for the build status
[07:29:23.257] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:29:23.257] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:131:0) after 1m0s
[07:30:23.300] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:131:0)
[07:30:23.300] Timer tick, asking Buildbucket for the build status
[07:30:23.517] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:30:23.517] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:132:0) after 1m0s
[07:31:23.519] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:132:0)
[07:31:23.519] Timer tick, asking Buildbucket for the build status
[07:31:24.664] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:31:24.664] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:133:0) after 1m0s
[07:32:24.699] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:133:0)
[07:32:24.699] Timer tick, asking Buildbucket for the build status
[07:32:25.901] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:32:25.901] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:134:0) after 1m0s
[07:33:25.923] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:134:0)
[07:33:25.923] Timer tick, asking Buildbucket for the build status
[07:33:26.161] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:33:26.161] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:135:0) after 1m0s
[07:34:26.215] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:135:0)
[07:34:26.215] Timer tick, asking Buildbucket for the build status
[07:34:26.847] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:34:26.847] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:136:0) after 1m0s
[07:35:26.874] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:136:0)
[07:35:26.874] Timer tick, asking Buildbucket for the build status
[07:35:29.256] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:35:29.256] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:137:0) after 1m0s
[07:36:29.329] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:137:0)
[07:36:29.329] Timer tick, asking Buildbucket for the build status
[07:36:30.222] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:36:30.222] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:138:0) after 1m0s
[07:37:30.264] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:138:0)
[07:37:30.264] Timer tick, asking Buildbucket for the build status
[07:37:30.490] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:37:30.490] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:139:0) after 1m0s
[07:38:30.557] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:139:0)
[07:38:30.558] Timer tick, asking Buildbucket for the build status
[07:38:30.787] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:38:30.787] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:140:0) after 1m0s
[07:39:30.956] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:140:0)
[07:39:30.956] Timer tick, asking Buildbucket for the build status
[07:39:41.253] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:39:41.253] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:141:0) after 1m0s
[07:40:41.537] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:141:0)
[07:40:41.537] Timer tick, asking Buildbucket for the build status
[07:40:41.756] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:40:41.756] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:142:0) after 1m0s
[07:41:41.829] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:142:0)
[07:41:41.829] Timer tick, asking Buildbucket for the build status
[07:41:42.061] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:41:42.061] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:143:0) after 1m0s
[07:42:42.278] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:143:0)
[07:42:42.278] Timer tick, asking Buildbucket for the build status
[07:42:44.001] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:42:44.001] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:144:0) after 1m0s
[07:43:44.014] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:144:0)
[07:43:44.014] Timer tick, asking Buildbucket for the build status
[07:43:44.937] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:43:44.937] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:145:0) after 1m0s
[07:44:45.172] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:145:0)
[07:44:45.172] Timer tick, asking Buildbucket for the build status
[07:44:45.633] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:44:45.633] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:146:0) after 1m0s
[07:45:45.676] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:146:0)
[07:45:45.676] Timer tick, asking Buildbucket for the build status
[07:45:46.420] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:45:46.420] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:147:0) after 1m0s
[07:46:46.456] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:147:0)
[07:46:46.456] Timer tick, asking Buildbucket for the build status
[07:46:47.021] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:46:47.021] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:148:0) after 1m0s
[07:47:47.230] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:148:0)
[07:47:47.230] Timer tick, asking Buildbucket for the build status
[07:47:47.430] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:47:47.430] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:149:0) after 1m0s
[07:48:47.675] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:149:0)
[07:48:47.675] Timer tick, asking Buildbucket for the build status
[07:48:47.868] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:48:47.868] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:150:0) after 1m0s
[07:49:48.027] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:150:0)
[07:49:48.027] Timer tick, asking Buildbucket for the build status
[07:49:54.834] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:49:54.834] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:151:0) after 1m0s
[07:50:55.016] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:151:0)
[07:50:55.016] Timer tick, asking Buildbucket for the build status
[07:50:55.316] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:50:55.316] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:152:0) after 1m0s
[07:51:55.375] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:152:0)
[07:51:55.376] Timer tick, asking Buildbucket for the build status
[07:51:56.111] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:51:56.111] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:153:0) after 1m0s
[07:52:56.197] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:153:0)
[07:52:56.197] Timer tick, asking Buildbucket for the build status
[07:52:56.491] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:52:56.491] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:154:0) after 1m0s
[07:53:56.581] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:154:0)
[07:53:56.581] Timer tick, asking Buildbucket for the build status
[07:53:59.095] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:53:59.095] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:155:0) after 1m0s
[07:54:59.152] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:155:0)
[07:54:59.152] Timer tick, asking Buildbucket for the build status
[07:54:59.867] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:54:59.867] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:156:0) after 1m0s
[07:55:59.901] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:156:0)
[07:55:59.901] Timer tick, asking Buildbucket for the build status
[07:56:00.511] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:56:00.511] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:157:0) after 1m0s
[07:57:00.619] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:157:0)
[07:57:00.619] Timer tick, asking Buildbucket for the build status
[07:57:01.693] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:57:01.693] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:158:0) after 1m0s
[07:58:01.852] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:158:0)
[07:58:01.852] Timer tick, asking Buildbucket for the build status
[07:58:02.158] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:58:02.158] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:159:0) after 1m0s
[07:59:02.339] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:159:0)
[07:59:02.339] Timer tick, asking Buildbucket for the build status
[07:59:03.215] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:59:03.215] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:160:0) after 1m0s
[08:00:03.459] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:160:0)
[08:00:03.459] Timer tick, asking Buildbucket for the build status
[08:00:09.338] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:00:09.338] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:161:0) after 1m0s
[08:01:09.485] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:161:0)
[08:01:09.485] Timer tick, asking Buildbucket for the build status
[08:01:09.933] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:01:09.933] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:162:0) after 1m0s
[08:02:10.742] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:162:0)
[08:02:10.742] Timer tick, asking Buildbucket for the build status
[08:02:13.592] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:02:13.592] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:163:0) after 1m0s
[08:03:13.817] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:163:0)
[08:03:13.817] Timer tick, asking Buildbucket for the build status
[08:03:16.986] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:03:16.986] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:164:0) after 1m0s
[08:04:17.334] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:164:0)
[08:04:17.334] Timer tick, asking Buildbucket for the build status
[08:04:18.604] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:04:18.604] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:165:0) after 1m0s
[08:05:18.670] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:165:0)
[08:05:18.670] Timer tick, asking Buildbucket for the build status
[08:05:19.007] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:05:19.007] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:166:0) after 1m0s
[08:06:19.099] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:166:0)
[08:06:19.099] Timer tick, asking Buildbucket for the build status
[08:06:20.200] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:06:20.200] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:167:0) after 1m0s
[08:07:20.292] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:167:0)
[08:07:20.292] Timer tick, asking Buildbucket for the build status
[08:07:25.342] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:07:25.342] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:168:0) after 1m0s
[08:08:25.363] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:168:0)
[08:08:25.363] Timer tick, asking Buildbucket for the build status
[08:08:26.528] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:08:26.528] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:169:0) after 1m0s
[08:09:26.962] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:169:0)
[08:09:26.962] Timer tick, asking Buildbucket for the build status
[08:09:27.695] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:09:27.695] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:170:0) after 1m0s
[08:10:27.796] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:170:0)
[08:10:27.796] Timer tick, asking Buildbucket for the build status
[08:10:28.239] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:10:28.239] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:171:0) after 1m0s
[08:11:28.314] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:171:0)
[08:11:28.314] Timer tick, asking Buildbucket for the build status
[08:11:28.784] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:11:28.784] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:172:0) after 1m0s
[08:12:28.823] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:172:0)
[08:12:28.823] Timer tick, asking Buildbucket for the build status
[08:12:29.052] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:12:29.052] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:173:0) after 1m0s
[08:13:29.116] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:173:0)
[08:13:29.116] Timer tick, asking Buildbucket for the build status
[08:13:29.958] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:13:29.958] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:174:0) after 1m0s
[08:14:30.077] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:174:0)
[08:14:30.077] Timer tick, asking Buildbucket for the build status
[08:14:30.547] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:14:30.547] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:175:0) after 1m0s
[08:15:30.621] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:175:0)
[08:15:30.621] Timer tick, asking Buildbucket for the build status
[08:15:31.296] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:15:31.296] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:176:0) after 1m0s
[08:16:31.475] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:176:0)
[08:16:31.475] Timer tick, asking Buildbucket for the build status
[08:16:32.068] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:16:32.068] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:177:0) after 1m0s
[08:17:32.181] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:177:0)
[08:17:32.181] Timer tick, asking Buildbucket for the build status
[08:17:32.565] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:17:32.565] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:178:0) after 1m0s
[08:18:32.660] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:178:0)
[08:18:32.660] Timer tick, asking Buildbucket for the build status
[08:18:37.600] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:18:37.600] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:179:0) after 1m0s
[08:19:37.753] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:179:0)
[08:19:37.753] Timer tick, asking Buildbucket for the build status
[08:19:38.266] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:19:38.266] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:180:0) after 1m0s
[08:20:38.380] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:180:0)
[08:20:38.380] Timer tick, asking Buildbucket for the build status
[08:20:38.537] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:20:38.537] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:181:0) after 1m0s
[08:21:38.578] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:181:0)
[08:21:38.578] Timer tick, asking Buildbucket for the build status
[08:21:38.788] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:21:38.788] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:182:0) after 1m0s
[08:22:38.915] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:182:0)
[08:22:38.915] Timer tick, asking Buildbucket for the build status
[08:22:39.847] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:22:39.847] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:183:0) after 1m0s
[08:23:39.931] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:183:0)
[08:23:39.931] Timer tick, asking Buildbucket for the build status
[08:23:40.913] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:23:40.913] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:184:0) after 1m0s
[08:24:40.931] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:184:0)
[08:24:40.931] Timer tick, asking Buildbucket for the build status
[08:24:41.107] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:24:41.107] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:185:0) after 1m0s
[08:25:41.178] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:185:0)
[08:25:41.178] Timer tick, asking Buildbucket for the build status
[08:25:43.298] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:25:43.298] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:186:0) after 1m0s
[08:26:43.338] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:186:0)
[08:26:43.338] Timer tick, asking Buildbucket for the build status
[08:26:43.860] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:26:43.860] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:187:0) after 1m0s
[08:27:43.888] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:187:0)
[08:27:43.888] Timer tick, asking Buildbucket for the build status
[08:27:44.257] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:27:44.257] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:188:0) after 1m0s
[08:28:44.283] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:188:0)
[08:28:44.283] Timer tick, asking Buildbucket for the build status
[08:28:44.519] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:28:44.519] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:189:0) after 1m0s
[08:29:44.558] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:189:0)
[08:29:44.558] Timer tick, asking Buildbucket for the build status
[08:29:44.745] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:29:44.745] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:190:0) after 1m0s
[08:30:44.748] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:190:0)
[08:30:44.749] Timer tick, asking Buildbucket for the build status
[08:30:44.951] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:30:44.951] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:191:0) after 1m0s
[08:31:45.120] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:191:0)
[08:31:45.120] Timer tick, asking Buildbucket for the build status
[08:31:45.358] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:31:45.358] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:192:0) after 1m0s
[08:32:45.409] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:192:0)
[08:32:45.409] Timer tick, asking Buildbucket for the build status
[08:32:45.631] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:32:45.631] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:193:0) after 1m0s
[08:33:45.892] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:193:0)
[08:33:45.892] Timer tick, asking Buildbucket for the build status
[08:33:47.501] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:33:47.501] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:194:0) after 1m0s
[08:34:47.553] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:194:0)
[08:34:47.553] Timer tick, asking Buildbucket for the build status
[08:34:48.501] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:34:48.501] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:195:0) after 1m0s
[08:35:48.650] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:195:0)
[08:35:48.650] Timer tick, asking Buildbucket for the build status
[08:35:49.965] Build 8900011392542083872: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:35:49.965] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9065441454603257632:196:0) after 1m0s
[08:36:35.701] Received PubSub notification, asking Buildbucket for the build status
[08:36:36.245] Build 8900011392542083872: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[08:36:36.245] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1570696593618546",
"created_by": "project:chromium",
"created_ts": "1570684741417665",
"id": "8900011392542083872",
"parameters_json": "{\"builder_name\": \"Windows deterministic\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"7e9c5d4e6befce7aef7679bc40e9cda611d61cd9\"}}",
"project": "chromium",
"result": "SUCCESS",
"result_details_json": "{\"properties\": {\"$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-kun4\", \"branch\": \"refs/heads/master\", \"buildername\": \"Windows deterministic\", \"buildnumber\": 14933, \"got_angle_revision\": \"d7323cf7f12d0a3fdfdbfa985d99066fdf0882ce\", \"got_dawn_revision\": \"e16a901fb85351a93b224ea1b7b6d603a07fd1cc\", \"got_nacl_revision\": \"3651f6c52037c96e034cc422746768d59182bff3\", \"got_revision\": \"7e9c5d4e6befce7aef7679bc40e9cda611d61cd9\", \"got_revision_cp\": \"refs/heads/master@{#704506}\", \"got_swarming_client_revision\": \"885b3febcc170a60f25795304e60927b77d1e92d\", \"got_v8_revision\": \"8374dec2128723dee4054d74e39f4acb3a84e8a8\", \"got_v8_revision_cp\": \"refs/heads/7.9.257@{#1}\", \"got_webrtc_revision\": \"066c2ab92f8034eea35ffced287ecaf08c9bb501\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#29423}\", \"mastername\": \"chromium.win\", \"path_config\": \"generic\", \"recipe\": \"swarming/deterministic_build\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"7e9c5d4e6befce7aef7679bc40e9cda611d61cd9\"}, \"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-kun4\"], \"image\": [\"chrome-win10-1703-19091300-a244b1e46d2\"], \"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\": [\"4501-487d554\"], \"ssd\": [\"0\"], \"windows_client_version\": [\"10\"], \"zone\": [\"us\", \"us-west\", \"us-west1\", \"us-west1-c\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1570684869491242",
"status": "COMPLETED",
"status_changed_ts": "1570696594708693",
"tags": [
"build_address:luci.chromium.ci/Windows deterministic/14933",
"builder:Windows deterministic",
"buildset:commit/git/7e9c5d4e6befce7aef7679bc40e9cda611d61cd9",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/7e9c5d4e6befce7aef7679bc40e9cda611d61cd9",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9065441454603257632",
"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/8900011392542083872/+/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:47ccecb3df894910",
"user_agent:luci-scheduler"
],
"updated_ts": "1570696594895628",
"url": "https://ci.chromium.org/b/8900011392542083872",
"utcnow_ts": "1570696596232495"
}
}
[08:36:36.245] Invocation finished in 3h17m36.176413833s with status SUCCEEDED