[04:01:00.233] New invocation is queued and will start shortly
[04:01:01.395] Starting the invocation (attempt 1)
[04:01:01.436] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[04:01:01.436] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[04:01:01.436] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9062728452791898688",
"parameters_json": "{\"builder_name\":\"Windows deterministic\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"d628b3c0772fb2c57e3089ec95bcf36eb134f978\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:Windows deterministic",
"scheduler_invocation_id:9062728452791898688",
"scheduler_job_id:chromium/Windows deterministic",
"user_agent:luci-scheduler",
"buildset:commit/git/d628b3c0772fb2c57e3089ec95bcf36eb134f978",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/d628b3c0772fb2c57e3089ec95bcf36eb134f978",
"gitiles_ref:refs/heads/master"
]
}
[04:01:09.750] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1573272065103851",
"id": "8897298387021247856",
"parameters_json": "{\"builder_name\": \"Windows deterministic\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"d628b3c0772fb2c57e3089ec95bcf36eb134f978\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1573272068379930",
"tags": [
"build_address:luci.chromium.ci/Windows deterministic/15154",
"builder:Windows deterministic",
"buildset:commit/git/d628b3c0772fb2c57e3089ec95bcf36eb134f978",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/d628b3c0772fb2c57e3089ec95bcf36eb134f978",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9062728452791898688",
"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/8897298387021247856/+/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": "1573272068380100",
"url": "https://ci.chromium.org/b/8897298387021247856",
"utcnow_ts": "1573272069688048"
}
}
[04:01:09.750] Task URL: https://ci.chromium.org/b/8897298387021247856
[04:01:09.750] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:2:0) after 1m0s
[04:01:15.890] Received PubSub notification, asking Buildbucket for the build status
[04:01:16.063] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:02:10.199] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:2:0)
[04:02:10.199] Timer tick, asking Buildbucket for the build status
[04:02:12.420] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:02:12.420] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:4:0) after 1m0s
[04:03:12.467] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:4:0)
[04:03:12.467] Timer tick, asking Buildbucket for the build status
[04:03:13.453] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:03:13.453] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:5:0) after 1m0s
[04:04:13.608] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:5:0)
[04:04:13.608] Timer tick, asking Buildbucket for the build status
[04:04:14.403] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:04:14.403] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:6:0) after 1m0s
[04:05:14.444] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:6:0)
[04:05:14.444] Timer tick, asking Buildbucket for the build status
[04:05:14.956] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:05:14.956] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:7:0) after 1m0s
[04:06:14.976] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:7:0)
[04:06:14.976] Timer tick, asking Buildbucket for the build status
[04:06:15.336] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:06:15.336] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:8:0) after 1m0s
[04:07:15.380] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:8:0)
[04:07:15.380] Timer tick, asking Buildbucket for the build status
[04:07:15.864] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:07:15.864] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:9:0) after 1m0s
[04:08:15.926] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:9:0)
[04:08:15.926] Timer tick, asking Buildbucket for the build status
[04:08:16.443] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:08:16.443] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:10:0) after 1m0s
[04:09:16.509] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:10:0)
[04:09:16.509] Timer tick, asking Buildbucket for the build status
[04:09:16.815] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:09:16.815] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:11:0) after 1m0s
[04:10:16.842] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:11:0)
[04:10:16.842] Timer tick, asking Buildbucket for the build status
[04:10:17.142] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:10:17.142] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:12:0) after 1m0s
[04:11:17.184] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:12:0)
[04:11:17.184] Timer tick, asking Buildbucket for the build status
[04:11:17.948] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:11:17.948] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:13:0) after 1m0s
[04:12:17.971] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:13:0)
[04:12:17.971] Timer tick, asking Buildbucket for the build status
[04:12:18.210] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:12:18.210] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:14:0) after 1m0s
[04:13:18.237] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:14:0)
[04:13:18.237] Timer tick, asking Buildbucket for the build status
[04:13:18.723] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:13:18.723] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:15:0) after 1m0s
[04:14:18.769] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:15:0)
[04:14:18.769] Timer tick, asking Buildbucket for the build status
[04:14:20.105] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:14:20.105] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:16:0) after 1m0s
[04:15:20.233] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:16:0)
[04:15:20.233] Timer tick, asking Buildbucket for the build status
[04:15:20.484] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:15:20.485] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:17:0) after 1m0s
[04:16:20.536] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:17:0)
[04:16:20.536] Timer tick, asking Buildbucket for the build status
[04:16:20.824] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:16:20.824] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:18:0) after 1m0s
[04:17:20.903] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:18:0)
[04:17:20.903] Timer tick, asking Buildbucket for the build status
[04:17:22.117] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:17:22.117] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:19:0) after 1m0s
[04:18:22.275] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:19:0)
[04:18:22.275] Timer tick, asking Buildbucket for the build status
[04:18:23.619] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:18:23.619] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:20:0) after 1m0s
[04:19:23.671] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:20:0)
[04:19:23.671] Timer tick, asking Buildbucket for the build status
[04:19:25.685] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:19:25.685] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:21:0) after 1m0s
[04:20:25.700] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:21:0)
[04:20:25.700] Timer tick, asking Buildbucket for the build status
[04:20:25.998] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:20:25.998] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:22:0) after 1m0s
[04:21:26.048] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:22:0)
[04:21:26.048] Timer tick, asking Buildbucket for the build status
[04:21:26.468] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:21:26.468] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:23:0) after 1m0s
[04:22:26.566] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:23:0)
[04:22:26.566] Timer tick, asking Buildbucket for the build status
[04:22:26.836] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:22:26.836] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:24:0) after 1m0s
[04:23:27.117] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:24:0)
[04:23:27.117] Timer tick, asking Buildbucket for the build status
[04:23:27.367] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:23:27.367] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:25:0) after 1m0s
[04:24:27.459] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:25:0)
[04:24:27.459] Timer tick, asking Buildbucket for the build status
[04:24:27.913] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:24:27.913] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:26:0) after 1m0s
[04:25:28.109] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:26:0)
[04:25:28.109] Timer tick, asking Buildbucket for the build status
[04:25:28.434] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:25:28.434] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:27:0) after 1m0s
[04:26:28.492] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:27:0)
[04:26:28.492] Timer tick, asking Buildbucket for the build status
[04:26:28.745] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:26:28.745] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:28:0) after 1m0s
[04:27:28.962] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:28:0)
[04:27:28.962] Timer tick, asking Buildbucket for the build status
[04:27:29.277] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:27:29.277] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:29:0) after 1m0s
[04:28:29.405] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:29:0)
[04:28:29.405] Timer tick, asking Buildbucket for the build status
[04:28:29.622] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:28:29.622] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:30:0) after 1m0s
[04:29:29.812] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:30:0)
[04:29:29.812] Timer tick, asking Buildbucket for the build status
[04:29:30.099] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:29:30.099] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:31:0) after 1m0s
[04:30:30.254] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:31:0)
[04:30:30.254] Timer tick, asking Buildbucket for the build status
[04:30:30.743] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:30:30.743] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:32:0) after 1m0s
[04:31:30.803] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:32:0)
[04:31:30.803] Timer tick, asking Buildbucket for the build status
[04:31:31.417] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:31:31.417] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:33:0) after 1m0s
[04:32:31.444] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:33:0)
[04:32:31.444] Timer tick, asking Buildbucket for the build status
[04:32:33.540] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:32:33.540] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:34:0) after 1m0s
[04:33:33.582] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:34:0)
[04:33:33.582] Timer tick, asking Buildbucket for the build status
[04:33:33.879] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:33:33.879] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:35:0) after 1m0s
[04:34:33.982] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:35:0)
[04:34:33.982] Timer tick, asking Buildbucket for the build status
[04:34:34.232] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:34:34.232] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:36:0) after 1m0s
[04:35:34.356] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:36:0)
[04:35:34.356] Timer tick, asking Buildbucket for the build status
[04:35:36.478] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:35:36.478] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:37:0) after 1m0s
[04:36:36.534] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:37:0)
[04:36:36.534] Timer tick, asking Buildbucket for the build status
[04:36:37.010] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:36:37.010] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:38:0) after 1m0s
[04:37:37.094] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:38:0)
[04:37:37.094] Timer tick, asking Buildbucket for the build status
[04:37:37.510] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:37:37.510] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:39:0) after 1m0s
[04:38:37.608] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:39:0)
[04:38:37.608] Timer tick, asking Buildbucket for the build status
[04:38:38.253] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:38:38.253] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:40:0) after 1m0s
[04:39:38.393] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:40:0)
[04:39:38.393] Timer tick, asking Buildbucket for the build status
[04:39:38.795] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:39:38.795] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:41:0) after 1m0s
[04:40:38.798] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:41:0)
[04:40:38.798] Timer tick, asking Buildbucket for the build status
[04:40:42.553] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:40:42.553] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:42:0) after 1m0s
[04:41:42.677] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:42:0)
[04:41:42.677] Timer tick, asking Buildbucket for the build status
[04:41:44.356] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:41:44.356] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:43:0) after 1m0s
[04:42:44.432] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:43:0)
[04:42:44.432] Timer tick, asking Buildbucket for the build status
[04:42:46.340] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:42:46.340] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:44:0) after 1m0s
[04:43:46.392] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:44:0)
[04:43:46.392] Timer tick, asking Buildbucket for the build status
[04:43:46.681] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:43:46.681] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:45:0) after 1m0s
[04:44:46.832] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:45:0)
[04:44:46.832] Timer tick, asking Buildbucket for the build status
[04:44:47.118] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:44:47.118] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:46:0) after 1m0s
[04:45:47.173] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:46:0)
[04:45:47.173] Timer tick, asking Buildbucket for the build status
[04:45:47.422] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:45:47.422] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:47:0) after 1m0s
[04:46:47.637] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:47:0)
[04:46:47.637] Timer tick, asking Buildbucket for the build status
[04:46:49.383] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:46:49.383] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:48:0) after 1m0s
[04:47:49.404] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:48:0)
[04:47:49.404] Timer tick, asking Buildbucket for the build status
[04:47:49.806] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:47:49.806] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:49:0) after 1m0s
[04:48:49.838] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:49:0)
[04:48:49.838] Timer tick, asking Buildbucket for the build status
[04:48:50.023] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:48:50.023] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:50:0) after 1m0s
[04:49:50.305] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:50:0)
[04:49:50.305] Timer tick, asking Buildbucket for the build status
[04:49:53.331] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:49:53.331] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:51:0) after 1m0s
[04:50:53.457] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:51:0)
[04:50:53.457] Timer tick, asking Buildbucket for the build status
[04:50:54.227] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:50:54.227] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:52:0) after 1m0s
[04:51:54.497] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:52:0)
[04:51:54.497] Timer tick, asking Buildbucket for the build status
[04:51:55.605] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:51:55.605] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:53:0) after 1m0s
[04:52:55.693] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:53:0)
[04:52:55.693] Timer tick, asking Buildbucket for the build status
[04:52:56.271] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:52:56.271] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:54:0) after 1m0s
[04:53:56.296] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:54:0)
[04:53:56.296] Timer tick, asking Buildbucket for the build status
[04:53:56.705] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:53:56.705] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:55:0) after 1m0s
[04:54:56.755] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:55:0)
[04:54:56.755] Timer tick, asking Buildbucket for the build status
[04:54:57.019] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:54:57.019] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:56:0) after 1m0s
[04:55:57.045] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:56:0)
[04:55:57.045] Timer tick, asking Buildbucket for the build status
[04:55:57.570] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:55:57.570] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:57:0) after 1m0s
[04:56:57.745] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:57:0)
[04:56:57.745] Timer tick, asking Buildbucket for the build status
[04:56:58.039] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:56:58.039] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:58:0) after 1m0s
[04:57:58.062] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:58:0)
[04:57:58.062] Timer tick, asking Buildbucket for the build status
[04:57:58.490] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:57:58.490] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:59:0) after 1m0s
[04:58:58.549] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:59:0)
[04:58:58.549] Timer tick, asking Buildbucket for the build status
[04:58:58.815] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:58:58.816] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:60:0) after 1m0s
[04:59:58.982] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:60:0)
[04:59:58.982] Timer tick, asking Buildbucket for the build status
[04:59:59.282] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:59:59.282] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:61:0) after 1m0s
[05:00:59.463] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:61:0)
[05:00:59.463] Timer tick, asking Buildbucket for the build status
[05:00:59.629] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:00:59.629] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:62:0) after 1m0s
[05:01:59.803] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:62:0)
[05:01:59.803] Timer tick, asking Buildbucket for the build status
[05:02:00.371] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:02:00.371] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:63:0) after 1m0s
[05:03:00.399] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:63:0)
[05:03:00.399] Timer tick, asking Buildbucket for the build status
[05:03:00.690] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:03:00.690] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:64:0) after 1m0s
[05:04:00.810] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:64:0)
[05:04:00.810] Timer tick, asking Buildbucket for the build status
[05:04:01.672] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:04:01.672] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:65:0) after 1m0s
[05:05:01.831] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:65:0)
[05:05:01.831] Timer tick, asking Buildbucket for the build status
[05:05:02.065] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:05:02.065] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:66:0) after 1m0s
[05:06:02.053] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:66:0)
[05:06:02.053] Timer tick, asking Buildbucket for the build status
[05:06:03.135] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:06:03.135] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:67:0) after 1m0s
[05:07:03.226] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:67:0)
[05:07:03.226] Timer tick, asking Buildbucket for the build status
[05:07:03.696] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:07:03.696] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:68:0) after 1m0s
[05:08:03.725] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:68:0)
[05:08:03.725] Timer tick, asking Buildbucket for the build status
[05:08:03.995] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:08:03.995] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:69:0) after 1m0s
[05:09:04.078] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:69:0)
[05:09:04.078] Timer tick, asking Buildbucket for the build status
[05:09:05.425] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:09:05.425] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:70:0) after 1m0s
[05:10:05.500] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:70:0)
[05:10:05.500] Timer tick, asking Buildbucket for the build status
[05:10:05.895] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:10:05.895] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:71:0) after 1m0s
[05:11:05.938] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:71:0)
[05:11:05.938] Timer tick, asking Buildbucket for the build status
[05:11:08.989] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:11:08.989] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:72:0) after 1m0s
[05:12:09.244] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:72:0)
[05:12:09.244] Timer tick, asking Buildbucket for the build status
[05:12:10.009] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:12:10.009] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:73:0) after 1m0s
[05:13:10.494] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:73:0)
[05:13:10.494] Timer tick, asking Buildbucket for the build status
[05:13:10.793] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:13:10.793] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:74:0) after 1m0s
[05:14:11.122] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:74:0)
[05:14:11.122] Timer tick, asking Buildbucket for the build status
[05:14:13.472] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:14:13.472] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:75:0) after 1m0s
[05:15:13.709] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:75:0)
[05:15:13.709] Timer tick, asking Buildbucket for the build status
[05:15:13.926] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:15:13.926] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:76:0) after 1m0s
[05:16:14.056] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:76:0)
[05:16:14.056] Timer tick, asking Buildbucket for the build status
[05:16:14.811] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:16:14.811] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:77:0) after 1m0s
[05:17:14.917] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:77:0)
[05:17:14.917] Timer tick, asking Buildbucket for the build status
[05:17:15.234] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:17:15.234] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:78:0) after 1m0s
[05:18:15.264] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:78:0)
[05:18:15.264] Timer tick, asking Buildbucket for the build status
[05:18:15.714] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:18:15.714] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:79:0) after 1m0s
[05:19:15.744] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:79:0)
[05:19:15.744] Timer tick, asking Buildbucket for the build status
[05:19:16.280] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:19:16.280] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:80:0) after 1m0s
[05:20:16.343] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:80:0)
[05:20:16.343] Timer tick, asking Buildbucket for the build status
[05:20:16.753] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:20:16.753] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:81:0) after 1m0s
[05:21:16.791] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:81:0)
[05:21:16.791] Timer tick, asking Buildbucket for the build status
[05:21:17.130] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:21:17.130] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:82:0) after 1m0s
[05:22:17.298] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:82:0)
[05:22:17.299] Timer tick, asking Buildbucket for the build status
[05:22:17.519] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:22:17.519] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:83:0) after 1m0s
[05:23:17.595] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:83:0)
[05:23:17.595] Timer tick, asking Buildbucket for the build status
[05:23:17.885] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:23:17.885] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:84:0) after 1m0s
[05:24:17.951] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:84:0)
[05:24:17.951] Timer tick, asking Buildbucket for the build status
[05:24:18.125] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:24:18.125] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:85:0) after 1m0s
[05:25:18.151] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:85:0)
[05:25:18.151] Timer tick, asking Buildbucket for the build status
[05:25:18.870] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:25:18.870] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:86:0) after 1m0s
[05:26:18.914] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:86:0)
[05:26:18.914] Timer tick, asking Buildbucket for the build status
[05:26:19.573] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:26:19.573] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:87:0) after 1m0s
[05:27:19.645] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:87:0)
[05:27:19.645] Timer tick, asking Buildbucket for the build status
[05:27:20.824] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:27:20.824] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:88:0) after 1m0s
[05:28:20.804] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:88:0)
[05:28:20.804] Timer tick, asking Buildbucket for the build status
[05:28:21.309] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:28:21.309] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:89:0) after 1m0s
[05:29:21.498] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:89:0)
[05:29:21.498] Timer tick, asking Buildbucket for the build status
[05:29:22.469] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:29:22.469] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:90:0) after 1m0s
[05:30:22.501] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:90:0)
[05:30:22.501] Timer tick, asking Buildbucket for the build status
[05:30:22.822] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:30:22.822] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:91:0) after 1m0s
[05:31:22.983] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:91:0)
[05:31:22.983] Timer tick, asking Buildbucket for the build status
[05:31:23.342] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:31:23.342] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:92:0) after 1m0s
[05:32:23.453] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:92:0)
[05:32:23.453] Timer tick, asking Buildbucket for the build status
[05:32:24.077] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:32:24.077] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:93:0) after 1m0s
[05:33:24.207] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:93:0)
[05:33:24.207] Timer tick, asking Buildbucket for the build status
[05:33:24.927] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:33:24.927] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:94:0) after 1m0s
[05:34:25.042] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:94:0)
[05:34:25.042] Timer tick, asking Buildbucket for the build status
[05:34:25.334] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:34:25.334] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:95:0) after 1m0s
[05:35:25.362] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:95:0)
[05:35:25.362] Timer tick, asking Buildbucket for the build status
[05:35:25.862] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:35:25.862] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:96:0) after 1m0s
[05:36:25.923] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:96:0)
[05:36:25.923] Timer tick, asking Buildbucket for the build status
[05:36:26.854] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:36:26.854] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:97:0) after 1m0s
[05:37:26.987] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:97:0)
[05:37:26.987] Timer tick, asking Buildbucket for the build status
[05:37:27.551] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:37:27.551] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:98:0) after 1m0s
[05:38:27.576] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:98:0)
[05:38:27.576] Timer tick, asking Buildbucket for the build status
[05:38:29.126] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:38:29.126] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:99:0) after 1m0s
[05:39:29.163] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:99:0)
[05:39:29.163] Timer tick, asking Buildbucket for the build status
[05:39:29.427] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:39:29.427] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:100:0) after 1m0s
[05:40:29.454] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:100:0)
[05:40:29.454] Timer tick, asking Buildbucket for the build status
[05:40:40.165] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:40:40.165] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:101:0) after 1m0s
[05:41:40.198] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:101:0)
[05:41:40.198] Timer tick, asking Buildbucket for the build status
[05:41:40.383] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:41:40.383] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:102:0) after 1m0s
[05:42:40.406] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:102:0)
[05:42:40.406] Timer tick, asking Buildbucket for the build status
[05:42:40.957] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:42:40.957] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:103:0) after 1m0s
[05:43:40.995] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:103:0)
[05:43:40.995] Timer tick, asking Buildbucket for the build status
[05:43:41.210] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:43:41.210] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:104:0) after 1m0s
[05:44:41.282] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:104:0)
[05:44:41.282] Timer tick, asking Buildbucket for the build status
[05:44:42.312] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:44:42.312] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:105:0) after 1m0s
[05:45:42.383] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:105:0)
[05:45:42.383] Timer tick, asking Buildbucket for the build status
[05:45:42.774] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:45:42.774] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:106:0) after 1m0s
[05:46:42.801] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:106:0)
[05:46:42.801] Timer tick, asking Buildbucket for the build status
[05:46:43.063] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:46:43.063] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:107:0) after 1m0s
[05:47:43.094] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:107:0)
[05:47:43.094] Timer tick, asking Buildbucket for the build status
[05:47:43.343] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:47:43.343] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:108:0) after 1m0s
[05:48:43.381] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:108:0)
[05:48:43.381] Timer tick, asking Buildbucket for the build status
[05:48:43.727] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:48:43.727] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:109:0) after 1m0s
[05:49:43.843] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:109:0)
[05:49:43.843] Timer tick, asking Buildbucket for the build status
[05:49:44.136] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:49:44.136] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:110:0) after 1m0s
[05:50:44.214] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:110:0)
[05:50:44.214] Timer tick, asking Buildbucket for the build status
[05:50:45.111] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:50:45.111] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:111:0) after 1m0s
[05:51:45.276] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:111:0)
[05:51:45.276] Timer tick, asking Buildbucket for the build status
[05:51:45.543] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:51:45.543] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:112:0) after 1m0s
[05:52:45.540] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:112:0)
[05:52:45.540] Timer tick, asking Buildbucket for the build status
[05:52:45.836] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:52:45.836] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:113:0) after 1m0s
[05:53:45.904] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:113:0)
[05:53:45.904] Timer tick, asking Buildbucket for the build status
[05:53:46.521] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:53:46.521] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:114:0) after 1m0s
[05:54:46.602] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:114:0)
[05:54:46.602] Timer tick, asking Buildbucket for the build status
[05:54:48.322] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:54:48.322] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:115:0) after 1m0s
[05:55:48.406] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:115:0)
[05:55:48.406] Timer tick, asking Buildbucket for the build status
[05:55:49.482] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:55:49.482] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:116:0) after 1m0s
[05:56:49.509] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:116:0)
[05:56:49.509] Timer tick, asking Buildbucket for the build status
[05:56:52.302] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:56:52.302] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:117:0) after 1m0s
[05:57:52.404] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:117:0)
[05:57:52.404] Timer tick, asking Buildbucket for the build status
[05:57:52.613] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:57:52.613] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:118:0) after 1m0s
[05:58:52.642] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:118:0)
[05:58:52.643] Timer tick, asking Buildbucket for the build status
[05:58:52.871] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:58:52.871] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:119:0) after 1m0s
[05:59:52.914] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:119:0)
[05:59:52.914] Timer tick, asking Buildbucket for the build status
[05:59:53.182] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:59:53.182] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:120:0) after 1m0s
[06:00:53.281] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:120:0)
[06:00:53.281] Timer tick, asking Buildbucket for the build status
[06:00:53.506] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:00:53.506] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:121:0) after 1m0s
[06:01:53.779] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:121:0)
[06:01:53.779] Timer tick, asking Buildbucket for the build status
[06:01:54.260] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:01:54.260] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:122:0) after 1m0s
[06:02:54.356] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:122:0)
[06:02:54.356] Timer tick, asking Buildbucket for the build status
[06:02:55.717] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:02:55.717] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:123:0) after 1m0s
[06:03:55.777] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:123:0)
[06:03:55.777] Timer tick, asking Buildbucket for the build status
[06:03:56.588] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:03:56.588] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:124:0) after 1m0s
[06:04:56.792] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:124:0)
[06:04:56.792] Timer tick, asking Buildbucket for the build status
[06:05:00.198] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:05:00.198] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:125:0) after 1m0s
[06:06:00.274] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:125:0)
[06:06:00.274] Timer tick, asking Buildbucket for the build status
[06:06:01.931] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:06:01.931] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:126:0) after 1m0s
[06:07:02.027] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:126:0)
[06:07:02.027] Timer tick, asking Buildbucket for the build status
[06:07:04.598] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:07:04.598] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:127:0) after 1m0s
[06:08:04.680] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:127:0)
[06:08:04.680] Timer tick, asking Buildbucket for the build status
[06:08:06.188] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:08:06.188] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:128:0) after 1m0s
[06:09:06.371] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:128:0)
[06:09:06.371] Timer tick, asking Buildbucket for the build status
[06:09:06.707] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:09:06.707] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:129:0) after 1m0s
[06:10:06.775] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:129:0)
[06:10:06.775] Timer tick, asking Buildbucket for the build status
[06:10:07.520] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:10:07.520] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:130:0) after 1m0s
[06:11:07.531] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:130:0)
[06:11:07.531] Timer tick, asking Buildbucket for the build status
[06:11:08.818] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:11:08.818] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:131:0) after 1m0s
[06:12:08.871] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:131:0)
[06:12:08.871] Timer tick, asking Buildbucket for the build status
[06:12:09.331] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:12:09.332] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:132:0) after 1m0s
[06:13:09.456] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:132:0)
[06:13:09.456] Timer tick, asking Buildbucket for the build status
[06:13:10.217] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:13:10.217] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:133:0) after 1m0s
[06:14:10.357] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:133:0)
[06:14:10.357] Timer tick, asking Buildbucket for the build status
[06:14:12.904] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:14:12.904] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:134:0) after 1m0s
[06:15:12.924] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:134:0)
[06:15:12.924] Timer tick, asking Buildbucket for the build status
[06:15:13.320] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:15:13.320] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:135:0) after 1m0s
[06:16:13.343] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:135:0)
[06:16:13.343] Timer tick, asking Buildbucket for the build status
[06:16:14.503] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:16:14.503] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:136:0) after 1m0s
[06:17:14.632] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:136:0)
[06:17:14.632] Timer tick, asking Buildbucket for the build status
[06:17:15.017] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:17:15.017] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:137:0) after 1m0s
[06:18:15.101] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:137:0)
[06:18:15.101] Timer tick, asking Buildbucket for the build status
[06:18:15.895] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:18:15.895] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:138:0) after 1m0s
[06:19:16.027] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:138:0)
[06:19:16.027] Timer tick, asking Buildbucket for the build status
[06:19:17.099] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:19:17.099] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:139:0) after 1m0s
[06:20:17.254] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:139:0)
[06:20:17.254] Timer tick, asking Buildbucket for the build status
[06:20:17.646] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:20:17.646] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:140:0) after 1m0s
[06:21:17.671] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:140:0)
[06:21:17.671] Timer tick, asking Buildbucket for the build status
[06:21:18.373] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:21:18.373] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:141:0) after 1m0s
[06:22:18.446] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:141:0)
[06:22:18.446] Timer tick, asking Buildbucket for the build status
[06:22:19.018] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:22:19.018] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:142:0) after 1m0s
[06:23:19.161] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:142:0)
[06:23:19.161] Timer tick, asking Buildbucket for the build status
[06:23:20.637] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:23:20.637] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:143:0) after 1m0s
[06:24:21.214] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:143:0)
[06:24:21.214] Timer tick, asking Buildbucket for the build status
[06:24:21.535] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:24:21.535] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:144:0) after 1m0s
[06:25:21.754] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:144:0)
[06:25:21.754] Timer tick, asking Buildbucket for the build status
[06:25:22.217] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:25:22.217] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:145:0) after 1m0s
[06:26:22.401] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:145:0)
[06:26:22.401] Timer tick, asking Buildbucket for the build status
[06:26:22.949] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:26:22.949] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:146:0) after 1m0s
[06:27:23.223] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:146:0)
[06:27:23.223] Timer tick, asking Buildbucket for the build status
[06:27:23.787] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:27:23.787] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:147:0) after 1m0s
[06:28:23.918] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:147:0)
[06:28:23.918] Timer tick, asking Buildbucket for the build status
[06:28:24.408] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:28:24.408] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:148:0) after 1m0s
[06:29:24.439] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:148:0)
[06:29:24.439] Timer tick, asking Buildbucket for the build status
[06:29:25.107] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:29:25.107] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:149:0) after 1m0s
[06:30:25.219] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:149:0)
[06:30:25.219] Timer tick, asking Buildbucket for the build status
[06:30:25.505] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:30:25.505] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:150:0) after 1m0s
[06:31:25.571] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:150:0)
[06:31:25.571] Timer tick, asking Buildbucket for the build status
[06:31:26.074] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:31:26.074] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:151:0) after 1m0s
[06:32:26.290] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:151:0)
[06:32:26.290] Timer tick, asking Buildbucket for the build status
[06:32:26.628] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:32:26.628] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:152:0) after 1m0s
[06:33:26.703] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:152:0)
[06:33:26.703] Timer tick, asking Buildbucket for the build status
[06:33:27.657] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:33:27.657] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:153:0) after 1m0s
[06:34:27.687] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:153:0)
[06:34:27.687] Timer tick, asking Buildbucket for the build status
[06:34:28.025] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:34:28.026] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:154:0) after 1m0s
[06:35:28.066] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:154:0)
[06:35:28.066] Timer tick, asking Buildbucket for the build status
[06:35:28.538] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:35:28.538] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:155:0) after 1m0s
[06:36:28.754] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:155:0)
[06:36:28.754] Timer tick, asking Buildbucket for the build status
[06:36:29.657] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:36:29.657] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:156:0) after 1m0s
[06:37:29.737] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:156:0)
[06:37:29.737] Timer tick, asking Buildbucket for the build status
[06:37:30.000] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:37:30.000] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:157:0) after 1m0s
[06:38:30.092] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:157:0)
[06:38:30.092] Timer tick, asking Buildbucket for the build status
[06:38:30.362] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:38:30.362] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:158:0) after 1m0s
[06:39:30.478] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:158:0)
[06:39:30.478] Timer tick, asking Buildbucket for the build status
[06:39:32.684] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:39:32.684] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:159:0) after 1m0s
[06:40:32.721] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:159:0)
[06:40:32.721] Timer tick, asking Buildbucket for the build status
[06:40:33.442] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:40:33.442] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:160:0) after 1m0s
[06:41:33.501] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:160:0)
[06:41:33.501] Timer tick, asking Buildbucket for the build status
[06:41:34.537] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:41:34.537] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:161:0) after 1m0s
[06:42:34.582] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:161:0)
[06:42:34.582] Timer tick, asking Buildbucket for the build status
[06:42:35.293] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:42:35.293] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:162:0) after 1m0s
[06:43:35.392] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:162:0)
[06:43:35.392] Timer tick, asking Buildbucket for the build status
[06:43:35.668] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:43:35.668] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:163:0) after 1m0s
[06:44:35.735] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:163:0)
[06:44:35.735] Timer tick, asking Buildbucket for the build status
[06:44:35.962] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:44:35.962] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:164:0) after 1m0s
[06:45:36.020] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:164:0)
[06:45:36.020] Timer tick, asking Buildbucket for the build status
[06:45:36.591] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:45:36.591] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:165:0) after 1m0s
[06:46:36.666] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:165:0)
[06:46:36.666] Timer tick, asking Buildbucket for the build status
[06:46:37.202] Build 8897298387021247856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:46:37.202] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9062728452791898688:166:0) after 1m0s
[06:47:30.196] Received PubSub notification, asking Buildbucket for the build status
[06:47:30.995] Build 8897298387021247856: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[06:47:30.995] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1573282049295395",
"created_by": "project:chromium",
"created_ts": "1573272065103851",
"id": "8897298387021247856",
"parameters_json": "{\"builder_name\": \"Windows deterministic\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"d628b3c0772fb2c57e3089ec95bcf36eb134f978\"}}",
"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-xdeu\", \"branch\": \"refs/heads/master\", \"buildername\": \"Windows deterministic\", \"buildnumber\": 15154, \"got_angle_revision\": \"012d15196023467be913ef6d537417be91e68e16\", \"got_dawn_revision\": \"39b4b38f4f36b8a74e351febe5617fb0c2e36d6a\", \"got_nacl_revision\": \"3651f6c52037c96e034cc422746768d59182bff3\", \"got_revision\": \"d628b3c0772fb2c57e3089ec95bcf36eb134f978\", \"got_revision_cp\": \"refs/heads/master@{#714078}\", \"got_swarming_client_revision\": \"885b3febcc170a60f25795304e60927b77d1e92d\", \"got_swiftshader_revision\": \"31edef751a8d8428db1fc9e0f68c345ab987811f\", \"got_v8_revision\": \"f2af41c8eab1506a56d1e12051aba072b7b0c5cd\", \"got_v8_revision_cp\": \"refs/heads/8.0.211@{#1}\", \"got_webrtc_revision\": \"d6b9b0a1f4132474c737b5e673e380c3d8e12e2c\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#29744}\", \"mastername\": \"chromium.win\", \"path_config\": \"generic\", \"recipe\": \"swarming/deterministic_build\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"d628b3c0772fb2c57e3089ec95bcf36eb134f978\"}, \"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-xdeu\"], \"image\": [\"chrome-win10-1703-19102400-d35fedf5a0d\"], \"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\": [\"4621-f8a5b1c\"], \"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": "1573272074555876",
"status": "COMPLETED",
"status_changed_ts": "1573282049647486",
"tags": [
"build_address:luci.chromium.ci/Windows deterministic/15154",
"builder:Windows deterministic",
"buildset:commit/git/d628b3c0772fb2c57e3089ec95bcf36eb134f978",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/d628b3c0772fb2c57e3089ec95bcf36eb134f978",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9062728452791898688",
"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/8897298387021247856/+/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:4867242d3abcd310",
"user_agent:luci-scheduler"
],
"updated_ts": "1573282049651359",
"url": "https://ci.chromium.org/b/8897298387021247856",
"utcnow_ts": "1573282050975359"
}
}
[06:47:30.995] Invocation finished in 2h46m30.778911927s with status SUCCEEDED