[22:56:26.144] New invocation is queued and will start shortly
[22:56:27.334] Starting the invocation (attempt 1)
[22:56:27.366] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[22:56:27.366] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[22:56:27.366] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9042091506225944064",
"parameters_json": "{\"builder_name\":\"Deterministic Linux\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"bef6b6b3a36f5a13161c7b5d4340b1285725ce0d\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:Deterministic Linux",
"scheduler_invocation_id:9042091506225944064",
"scheduler_job_id:chromium/Deterministic Linux",
"user_agent:luci-scheduler",
"buildset:commit/git/bef6b6b3a36f5a13161c7b5d4340b1285725ce0d",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/bef6b6b3a36f5a13161c7b5d4340b1285725ce0d",
"gitiles_ref:refs/heads/master"
]
}
[22:56:29.401] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1592952987533898",
"id": "8876661444103334160",
"parameters_json": "{\"builder_name\": \"Deterministic Linux\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"bef6b6b3a36f5a13161c7b5d4340b1285725ce0d\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1592952988756175",
"tags": [
"build_address:luci.chromium.ci/Deterministic Linux/28291",
"builder:Deterministic Linux",
"buildset:commit/git/bef6b6b3a36f5a13161c7b5d4340b1285725ce0d",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/bef6b6b3a36f5a13161c7b5d4340b1285725ce0d",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9042091506225944064",
"scheduler_job_id:chromium/Deterministic Linux",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8876661444103334160/+/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": "1592952988756311",
"url": "https://ci.chromium.org/b/8876661444103334160",
"utcnow_ts": "1592952989392177"
}
}
[22:56:29.401] Task URL: https://ci.chromium.org/b/8876661444103334160
[22:56:29.401] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:2:0) after 1m0s
[22:57:29.500] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:2:0)
[22:57:29.500] Timer tick, asking Buildbucket for the build status
[22:57:29.671] Build 8876661444103334160: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[22:57:29.671] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:3:0) after 1m0s
[22:58:29.710] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:3:0)
[22:58:29.710] Timer tick, asking Buildbucket for the build status
[22:58:29.897] Build 8876661444103334160: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[22:58:29.897] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:4:0) after 1m0s
[22:59:10.089] Received PubSub notification, asking Buildbucket for the build status
[22:59:10.279] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:59:29.942] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:4:0)
[22:59:29.942] Timer tick, asking Buildbucket for the build status
[22:59:30.010] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:59:30.010] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:6:0) after 1m0s
[23:00:30.034] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:6:0)
[23:00:30.034] Timer tick, asking Buildbucket for the build status
[23:00:30.151] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:00:30.151] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:7:0) after 1m0s
[23:01:30.181] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:7:0)
[23:01:30.181] Timer tick, asking Buildbucket for the build status
[23:01:30.393] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:01:30.393] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:8:0) after 1m0s
[23:02:30.537] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:8:0)
[23:02:30.537] Timer tick, asking Buildbucket for the build status
[23:02:30.639] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:02:30.639] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:9:0) after 1m0s
[23:03:30.803] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:9:0)
[23:03:30.803] Timer tick, asking Buildbucket for the build status
[23:03:31.173] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:03:31.173] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:10:0) after 1m0s
[23:04:31.250] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:10:0)
[23:04:31.250] Timer tick, asking Buildbucket for the build status
[23:04:31.856] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:04:31.856] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:11:0) after 1m0s
[23:05:31.866] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:11:0)
[23:05:31.866] Timer tick, asking Buildbucket for the build status
[23:05:31.982] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:05:31.982] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:12:0) after 1m0s
[23:06:32.156] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:12:0)
[23:06:32.156] Timer tick, asking Buildbucket for the build status
[23:06:32.397] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:06:32.397] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:13:0) after 1m0s
[23:07:32.502] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:13:0)
[23:07:32.502] Timer tick, asking Buildbucket for the build status
[23:07:32.632] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:07:32.633] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:14:0) after 1m0s
[23:08:32.752] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:14:0)
[23:08:32.752] Timer tick, asking Buildbucket for the build status
[23:08:33.581] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:08:33.581] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:15:0) after 1m0s
[23:09:33.681] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:15:0)
[23:09:33.681] Timer tick, asking Buildbucket for the build status
[23:09:33.760] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:09:33.760] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:16:0) after 1m0s
[23:10:33.853] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:16:0)
[23:10:33.853] Timer tick, asking Buildbucket for the build status
[23:10:34.033] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:10:34.033] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:17:0) after 1m0s
[23:11:34.056] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:17:0)
[23:11:34.056] Timer tick, asking Buildbucket for the build status
[23:11:34.142] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:11:34.142] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:18:0) after 1m0s
[23:12:34.250] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:18:0)
[23:12:34.251] Timer tick, asking Buildbucket for the build status
[23:12:34.659] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:12:34.659] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:19:0) after 1m0s
[23:13:34.713] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:19:0)
[23:13:34.713] Timer tick, asking Buildbucket for the build status
[23:13:34.969] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:13:34.969] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:20:0) after 1m0s
[23:14:35.047] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:20:0)
[23:14:35.047] Timer tick, asking Buildbucket for the build status
[23:14:35.236] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:14:35.236] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:21:0) after 1m0s
[23:15:35.247] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:21:0)
[23:15:35.247] Timer tick, asking Buildbucket for the build status
[23:15:35.567] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:15:35.567] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:22:0) after 1m0s
[23:16:35.609] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:22:0)
[23:16:35.609] Timer tick, asking Buildbucket for the build status
[23:16:38.075] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:16:38.075] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:23:0) after 1m0s
[23:17:38.122] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:23:0)
[23:17:38.122] Timer tick, asking Buildbucket for the build status
[23:17:38.329] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:17:38.329] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:24:0) after 1m0s
[23:18:38.323] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:24:0)
[23:18:38.323] Timer tick, asking Buildbucket for the build status
[23:18:38.429] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:18:38.429] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:25:0) after 1m0s
[23:19:38.538] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:25:0)
[23:19:38.538] Timer tick, asking Buildbucket for the build status
[23:19:38.762] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:19:38.762] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:26:0) after 1m0s
[23:20:38.872] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:26:0)
[23:20:38.872] Timer tick, asking Buildbucket for the build status
[23:20:38.924] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:20:38.924] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:27:0) after 1m0s
[23:21:38.945] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:27:0)
[23:21:38.945] Timer tick, asking Buildbucket for the build status
[23:21:39.115] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:21:39.115] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:28:0) after 1m0s
[23:22:39.188] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:28:0)
[23:22:39.188] Timer tick, asking Buildbucket for the build status
[23:22:39.256] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:22:39.256] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:29:0) after 1m0s
[23:23:39.363] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:29:0)
[23:23:39.363] Timer tick, asking Buildbucket for the build status
[23:23:40.601] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:23:40.601] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:30:0) after 1m0s
[23:24:40.588] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:30:0)
[23:24:40.588] Timer tick, asking Buildbucket for the build status
[23:24:40.706] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:24:40.707] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:31:0) after 1m0s
[23:25:40.754] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:31:0)
[23:25:40.754] Timer tick, asking Buildbucket for the build status
[23:25:40.935] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:25:40.935] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:32:0) after 1m0s
[23:26:40.963] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:32:0)
[23:26:40.963] Timer tick, asking Buildbucket for the build status
[23:26:41.155] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:26:41.155] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:33:0) after 1m0s
[23:27:41.184] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:33:0)
[23:27:41.184] Timer tick, asking Buildbucket for the build status
[23:27:41.280] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:27:41.280] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:34:0) after 1m0s
[23:28:41.402] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:34:0)
[23:28:41.402] Timer tick, asking Buildbucket for the build status
[23:28:42.265] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:28:42.265] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:35:0) after 1m0s
[23:29:42.341] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:35:0)
[23:29:42.341] Timer tick, asking Buildbucket for the build status
[23:29:42.463] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:29:42.463] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:36:0) after 1m0s
[23:30:42.474] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:36:0)
[23:30:42.474] Timer tick, asking Buildbucket for the build status
[23:30:43.282] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:30:43.282] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:37:0) after 1m0s
[23:31:43.330] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:37:0)
[23:31:43.330] Timer tick, asking Buildbucket for the build status
[23:31:43.457] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:31:43.457] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:38:0) after 1m0s
[23:32:43.487] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:38:0)
[23:32:43.487] Timer tick, asking Buildbucket for the build status
[23:32:43.614] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:32:43.614] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:39:0) after 1m0s
[23:33:43.609] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:39:0)
[23:33:43.609] Timer tick, asking Buildbucket for the build status
[23:33:44.187] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:33:44.187] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:40:0) after 1m0s
[23:34:44.255] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:40:0)
[23:34:44.255] Timer tick, asking Buildbucket for the build status
[23:34:44.357] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:34:44.358] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:41:0) after 1m0s
[23:35:44.395] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:41:0)
[23:35:44.395] Timer tick, asking Buildbucket for the build status
[23:35:44.475] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:35:44.475] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:42:0) after 1m0s
[23:36:44.700] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:42:0)
[23:36:44.700] Timer tick, asking Buildbucket for the build status
[23:36:44.875] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:36:44.875] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:43:0) after 1m0s
[23:37:44.925] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:43:0)
[23:37:44.925] Timer tick, asking Buildbucket for the build status
[23:37:45.013] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:37:45.013] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:44:0) after 1m0s
[23:38:45.057] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:44:0)
[23:38:45.057] Timer tick, asking Buildbucket for the build status
[23:38:45.223] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:38:45.223] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:45:0) after 1m0s
[23:39:45.282] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:45:0)
[23:39:45.282] Timer tick, asking Buildbucket for the build status
[23:39:45.347] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:39:45.347] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:46:0) after 1m0s
[23:40:45.369] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:46:0)
[23:40:45.369] Timer tick, asking Buildbucket for the build status
[23:40:45.597] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:40:45.597] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:47:0) after 1m0s
[23:41:45.651] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:47:0)
[23:41:45.651] Timer tick, asking Buildbucket for the build status
[23:41:45.854] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:41:45.854] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:48:0) after 1m0s
[23:42:45.978] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:48:0)
[23:42:45.978] Timer tick, asking Buildbucket for the build status
[23:42:46.093] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:42:46.093] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:49:0) after 1m0s
[23:43:46.144] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:49:0)
[23:43:46.144] Timer tick, asking Buildbucket for the build status
[23:43:46.716] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:43:46.716] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:50:0) after 1m0s
[23:44:46.690] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:50:0)
[23:44:46.690] Timer tick, asking Buildbucket for the build status
[23:44:46.870] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:44:46.870] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:51:0) after 1m0s
[23:45:46.905] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:51:0)
[23:45:46.905] Timer tick, asking Buildbucket for the build status
[23:45:47.031] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:45:47.031] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:52:0) after 1m0s
[23:46:47.057] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:52:0)
[23:46:47.057] Timer tick, asking Buildbucket for the build status
[23:46:47.153] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:46:47.153] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:53:0) after 1m0s
[23:47:47.199] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:53:0)
[23:47:47.199] Timer tick, asking Buildbucket for the build status
[23:47:47.467] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:47:47.467] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:54:0) after 1m0s
[23:48:47.581] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:54:0)
[23:48:47.581] Timer tick, asking Buildbucket for the build status
[23:48:48.534] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:48:48.534] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:55:0) after 1m0s
[23:49:48.568] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:55:0)
[23:49:48.568] Timer tick, asking Buildbucket for the build status
[23:49:48.740] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:49:48.740] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:56:0) after 1m0s
[23:50:48.748] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:56:0)
[23:50:48.748] Timer tick, asking Buildbucket for the build status
[23:50:49.457] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:50:49.457] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:57:0) after 1m0s
[23:51:49.522] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:57:0)
[23:51:49.522] Timer tick, asking Buildbucket for the build status
[23:51:49.591] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:51:49.591] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:58:0) after 1m0s
[23:52:49.613] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:58:0)
[23:52:49.613] Timer tick, asking Buildbucket for the build status
[23:52:49.937] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:52:49.937] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:59:0) after 1m0s
[23:53:50.116] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:59:0)
[23:53:50.116] Timer tick, asking Buildbucket for the build status
[23:53:50.756] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:53:50.756] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:60:0) after 1m0s
[23:54:50.825] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:60:0)
[23:54:50.825] Timer tick, asking Buildbucket for the build status
[23:54:50.922] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:54:50.922] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:61:0) after 1m0s
[23:55:50.921] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:61:0)
[23:55:50.921] Timer tick, asking Buildbucket for the build status
[23:55:51.248] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:55:51.248] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:62:0) after 1m0s
[23:56:51.305] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:62:0)
[23:56:51.305] Timer tick, asking Buildbucket for the build status
[23:56:51.413] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:56:51.413] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:63:0) after 1m0s
[23:57:51.453] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:63:0)
[23:57:51.453] Timer tick, asking Buildbucket for the build status
[23:57:51.682] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:57:51.682] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:64:0) after 1m0s
[23:58:51.708] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:64:0)
[23:58:51.708] Timer tick, asking Buildbucket for the build status
[23:58:56.349] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:58:56.349] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:65:0) after 1m0s
[23:59:56.429] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:65:0)
[23:59:56.429] Timer tick, asking Buildbucket for the build status
[23:59:56.813] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:59:56.813] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:66:0) after 1m0s
[00:00:56.921] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:66:0)
[00:00:56.921] Timer tick, asking Buildbucket for the build status
[00:00:57.232] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:00:57.232] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:67:0) after 1m0s
[00:01:57.253] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:67:0)
[00:01:57.253] Timer tick, asking Buildbucket for the build status
[00:01:57.311] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:01:57.311] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:68:0) after 1m0s
[00:02:57.365] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:68:0)
[00:02:57.365] Timer tick, asking Buildbucket for the build status
[00:02:57.464] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:02:57.464] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:69:0) after 1m0s
[00:03:57.520] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:69:0)
[00:03:57.520] Timer tick, asking Buildbucket for the build status
[00:03:57.851] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:03:57.852] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:70:0) after 1m0s
[00:04:57.889] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:70:0)
[00:04:57.889] Timer tick, asking Buildbucket for the build status
[00:04:57.977] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:04:57.977] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:71:0) after 1m0s
[00:05:58.090] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:71:0)
[00:05:58.090] Timer tick, asking Buildbucket for the build status
[00:05:58.174] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:05:58.174] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:72:0) after 1m0s
[00:06:58.211] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:72:0)
[00:06:58.211] Timer tick, asking Buildbucket for the build status
[00:06:58.346] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:06:58.346] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:73:0) after 1m0s
[00:07:58.413] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:73:0)
[00:07:58.413] Timer tick, asking Buildbucket for the build status
[00:07:58.529] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:07:58.529] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:74:0) after 1m0s
[00:08:58.563] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:74:0)
[00:08:58.563] Timer tick, asking Buildbucket for the build status
[00:09:00.263] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:09:00.263] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:75:0) after 1m0s
[00:10:01.574] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:75:0)
[00:10:01.574] Timer tick, asking Buildbucket for the build status
[00:10:01.871] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:10:01.871] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:76:0) after 1m0s
[00:11:02.149] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:76:0)
[00:11:02.149] Timer tick, asking Buildbucket for the build status
[00:11:02.289] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:11:02.289] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:77:0) after 1m0s
[00:12:02.648] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:77:0)
[00:12:02.648] Timer tick, asking Buildbucket for the build status
[00:12:02.848] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:12:02.849] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:78:0) after 1m0s
[00:13:02.874] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:78:0)
[00:13:02.874] Timer tick, asking Buildbucket for the build status
[00:13:03.123] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:13:03.123] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:79:0) after 1m0s
[00:14:03.257] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:79:0)
[00:14:03.257] Timer tick, asking Buildbucket for the build status
[00:14:04.807] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:14:04.807] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:80:0) after 1m0s
[00:15:04.838] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:80:0)
[00:15:04.838] Timer tick, asking Buildbucket for the build status
[00:15:04.912] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:15:04.912] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:81:0) after 1m0s
[00:16:05.074] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:81:0)
[00:16:05.074] Timer tick, asking Buildbucket for the build status
[00:16:05.297] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:16:05.297] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:82:0) after 1m0s
[00:17:05.305] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:82:0)
[00:17:05.305] Timer tick, asking Buildbucket for the build status
[00:17:05.710] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:17:05.710] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:83:0) after 1m0s
[00:18:05.714] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:83:0)
[00:18:05.714] Timer tick, asking Buildbucket for the build status
[00:18:05.902] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:18:05.902] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:84:0) after 1m0s
[00:19:05.981] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:84:0)
[00:19:05.981] Timer tick, asking Buildbucket for the build status
[00:19:06.980] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:19:06.980] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:85:0) after 1m0s
[00:20:07.033] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:85:0)
[00:20:07.033] Timer tick, asking Buildbucket for the build status
[00:20:07.237] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:20:07.237] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:86:0) after 1m0s
[00:21:07.289] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:86:0)
[00:21:07.289] Timer tick, asking Buildbucket for the build status
[00:21:07.371] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:21:07.371] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:87:0) after 1m0s
[00:22:07.492] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:87:0)
[00:22:07.492] Timer tick, asking Buildbucket for the build status
[00:22:07.557] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:22:07.557] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:88:0) after 1m0s
[00:23:07.672] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:88:0)
[00:23:07.672] Timer tick, asking Buildbucket for the build status
[00:23:07.792] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:23:07.792] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:89:0) after 1m0s
[00:24:07.893] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:89:0)
[00:24:07.893] Timer tick, asking Buildbucket for the build status
[00:24:08.055] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:24:08.055] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:90:0) after 1m0s
[00:25:08.121] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:90:0)
[00:25:08.121] Timer tick, asking Buildbucket for the build status
[00:25:08.224] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:25:08.224] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:91:0) after 1m0s
[00:26:08.337] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:91:0)
[00:26:08.337] Timer tick, asking Buildbucket for the build status
[00:26:08.445] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:26:08.445] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:92:0) after 1m0s
[00:27:08.524] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:92:0)
[00:27:08.524] Timer tick, asking Buildbucket for the build status
[00:27:08.620] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:27:08.620] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:93:0) after 1m0s
[00:28:08.725] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:93:0)
[00:28:08.725] Timer tick, asking Buildbucket for the build status
[00:28:08.875] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:28:08.875] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:94:0) after 1m0s
[00:29:08.999] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:94:0)
[00:29:08.999] Timer tick, asking Buildbucket for the build status
[00:29:09.131] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:29:09.131] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:95:0) after 1m0s
[00:30:09.372] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:95:0)
[00:30:09.372] Timer tick, asking Buildbucket for the build status
[00:30:09.457] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:30:09.457] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:96:0) after 1m0s
[00:31:09.651] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:96:0)
[00:31:09.651] Timer tick, asking Buildbucket for the build status
[00:31:09.802] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:31:09.802] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:97:0) after 1m0s
[00:32:10.043] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:97:0)
[00:32:10.043] Timer tick, asking Buildbucket for the build status
[00:32:11.217] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:32:11.217] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:98:0) after 1m0s
[00:33:11.291] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:98:0)
[00:33:11.291] Timer tick, asking Buildbucket for the build status
[00:33:11.462] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:33:11.462] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:99:0) after 1m0s
[00:34:11.467] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:99:0)
[00:34:11.467] Timer tick, asking Buildbucket for the build status
[00:34:11.845] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:34:11.845] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:100:0) after 1m0s
[00:35:12.022] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:100:0)
[00:35:12.022] Timer tick, asking Buildbucket for the build status
[00:35:12.302] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:35:12.302] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:101:0) after 1m0s
[00:36:12.380] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:101:0)
[00:36:12.380] Timer tick, asking Buildbucket for the build status
[00:36:12.617] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:36:12.617] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:102:0) after 1m0s
[00:37:12.735] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:102:0)
[00:37:12.735] Timer tick, asking Buildbucket for the build status
[00:37:12.837] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:37:12.837] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:103:0) after 1m0s
[00:38:13.094] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:103:0)
[00:38:13.094] Timer tick, asking Buildbucket for the build status
[00:38:13.175] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:38:13.175] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:104:0) after 1m0s
[00:39:13.620] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:104:0)
[00:39:13.620] Timer tick, asking Buildbucket for the build status
[00:39:13.880] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:39:13.880] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:105:0) after 1m0s
[00:40:14.050] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:105:0)
[00:40:14.050] Timer tick, asking Buildbucket for the build status
[00:40:14.297] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:40:14.297] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:106:0) after 1m0s
[00:41:14.582] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:106:0)
[00:41:14.582] Timer tick, asking Buildbucket for the build status
[00:41:14.736] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:41:14.736] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:107:0) after 1m0s
[00:42:15.240] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:107:0)
[00:42:15.240] Timer tick, asking Buildbucket for the build status
[00:42:15.705] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:42:15.705] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:108:0) after 1m0s
[00:43:15.786] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:108:0)
[00:43:15.786] Timer tick, asking Buildbucket for the build status
[00:43:15.952] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:43:15.952] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:109:0) after 1m0s
[00:44:16.016] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:109:0)
[00:44:16.016] Timer tick, asking Buildbucket for the build status
[00:44:16.195] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:44:16.195] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:110:0) after 1m0s
[00:45:16.210] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:110:0)
[00:45:16.210] Timer tick, asking Buildbucket for the build status
[00:45:16.272] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:45:16.272] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:111:0) after 1m0s
[00:46:16.313] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:111:0)
[00:46:16.313] Timer tick, asking Buildbucket for the build status
[00:46:16.400] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:46:16.400] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:112:0) after 1m0s
[00:47:16.432] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:112:0)
[00:47:16.432] Timer tick, asking Buildbucket for the build status
[00:47:16.501] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:47:16.501] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:113:0) after 1m0s
[00:48:16.573] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:113:0)
[00:48:16.573] Timer tick, asking Buildbucket for the build status
[00:48:16.848] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:48:16.848] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:114:0) after 1m0s
[00:49:16.895] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:114:0)
[00:49:16.895] Timer tick, asking Buildbucket for the build status
[00:49:17.019] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:49:17.019] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:115:0) after 1m0s
[00:50:17.025] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:115:0)
[00:50:17.025] Timer tick, asking Buildbucket for the build status
[00:50:17.167] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:50:17.167] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:116:0) after 1m0s
[00:51:17.208] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:116:0)
[00:51:17.208] Timer tick, asking Buildbucket for the build status
[00:51:17.311] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:51:17.311] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:117:0) after 1m0s
[00:52:17.369] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:117:0)
[00:52:17.369] Timer tick, asking Buildbucket for the build status
[00:52:19.119] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:52:19.119] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:118:0) after 1m0s
[00:53:19.187] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:118:0)
[00:53:19.187] Timer tick, asking Buildbucket for the build status
[00:53:19.387] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:53:19.387] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:119:0) after 1m0s
[00:54:19.571] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:119:0)
[00:54:19.571] Timer tick, asking Buildbucket for the build status
[00:54:19.741] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:54:19.741] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:120:0) after 1m0s
[00:55:19.761] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:120:0)
[00:55:19.761] Timer tick, asking Buildbucket for the build status
[00:55:19.937] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:55:19.938] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:121:0) after 1m0s
[00:56:19.993] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:121:0)
[00:56:19.993] Timer tick, asking Buildbucket for the build status
[00:56:20.112] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:56:20.112] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:122:0) after 1m0s
[00:57:20.152] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:122:0)
[00:57:20.152] Timer tick, asking Buildbucket for the build status
[00:57:20.225] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:57:20.225] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:123:0) after 1m0s
[00:58:20.317] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:123:0)
[00:58:20.317] Timer tick, asking Buildbucket for the build status
[00:58:20.418] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:58:20.418] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:124:0) after 1m0s
[00:59:20.511] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:124:0)
[00:59:20.511] Timer tick, asking Buildbucket for the build status
[00:59:20.634] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:59:20.634] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:125:0) after 1m0s
[01:00:20.826] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:125:0)
[01:00:20.826] Timer tick, asking Buildbucket for the build status
[01:00:20.972] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:00:20.972] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:126:0) after 1m0s
[01:01:21.101] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:126:0)
[01:01:21.101] Timer tick, asking Buildbucket for the build status
[01:01:21.972] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:01:21.972] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:127:0) after 1m0s
[01:02:22.056] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:127:0)
[01:02:22.056] Timer tick, asking Buildbucket for the build status
[01:02:22.190] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:02:22.190] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:128:0) after 1m0s
[01:03:22.273] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:128:0)
[01:03:22.273] Timer tick, asking Buildbucket for the build status
[01:03:22.454] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:03:22.454] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:129:0) after 1m0s
[01:04:22.467] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:129:0)
[01:04:22.467] Timer tick, asking Buildbucket for the build status
[01:04:22.614] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:04:22.614] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:130:0) after 1m0s
[01:05:22.674] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:130:0)
[01:05:22.674] Timer tick, asking Buildbucket for the build status
[01:05:22.773] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:05:22.773] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:131:0) after 1m0s
[01:06:22.881] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:131:0)
[01:06:22.881] Timer tick, asking Buildbucket for the build status
[01:06:22.942] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:06:22.942] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:132:0) after 1m0s
[01:07:23.008] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:132:0)
[01:07:23.008] Timer tick, asking Buildbucket for the build status
[01:07:23.112] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:07:23.112] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:133:0) after 1m0s
[01:08:23.314] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:133:0)
[01:08:23.314] Timer tick, asking Buildbucket for the build status
[01:08:23.519] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:08:23.519] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:134:0) after 1m0s
[01:09:23.611] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:134:0)
[01:09:23.611] Timer tick, asking Buildbucket for the build status
[01:09:24.193] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:09:24.193] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:135:0) after 1m0s
[01:10:24.189] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:135:0)
[01:10:24.189] Timer tick, asking Buildbucket for the build status
[01:10:24.261] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:10:24.261] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:136:0) after 1m0s
[01:11:24.321] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:136:0)
[01:11:24.321] Timer tick, asking Buildbucket for the build status
[01:11:24.383] Build 8876661444103334160: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:11:24.383] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9042091506225944064:137:0) after 1m0s
[01:11:30.978] Received PubSub notification, asking Buildbucket for the build status
[01:11:31.083] Build 8876661444103334160: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[01:11:31.083] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1592961090228290",
"created_by": "project:chromium",
"created_ts": "1592952987533898",
"id": "8876661444103334160",
"parameters_json": "{\"builder_name\": \"Deterministic Linux\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"bef6b6b3a36f5a13161c7b5d4340b1285725ce0d\"}}",
"project": "chromium",
"result": "SUCCESS",
"result_details_json": "{\"properties\": {\"$build/goma\": {\"enable_ats\": true, \"jobs\": 500.0, \"rpc_extra_params\": \"?prod\", \"server_host\": \"goma.chromium.org\"}, \"$recipe_engine/path\": {\"cache_dir\": \"/b/s/w/ir/cache\", \"temp_dir\": \"/b/s/w/ir/tmp/rt\"}, \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"bot_id\": \"luci-chromium-ci-xenial-us-central1-b-8-88-b78w\", \"branch\": \"refs/heads/master\", \"buildername\": \"Deterministic Linux\", \"buildnumber\": 28291, \"got_angle_revision\": \"b47cc50aadb661e64e9a709e33c3a638d391ffe1\", \"got_dawn_revision\": \"10e4a44ce6512887861f1b5c6801655029bf8350\", \"got_nacl_revision\": \"fd20fafa8ec19700e12daa031bf792bae8b6bb21\", \"got_revision\": \"bef6b6b3a36f5a13161c7b5d4340b1285725ce0d\", \"got_revision_cp\": \"refs/heads/master@{#781588}\", \"got_swarming_client_revision\": \"4c095d04179dc725a300085ae21fe3b79900d072\", \"got_swiftshader_revision\": \"eb0a25a189b75d950ae4f87c00f8d63f190d82a0\", \"got_v8_revision\": \"df9f2eb52c315f000fb57f32fda4335c824868bd\", \"got_v8_revision_cp\": \"refs/heads/8.5.201@{#1}\", \"got_webrtc_revision\": \"24762f207fa13d7168f889ee5443ee5de6ad32f6\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#31551}\", \"mastername\": \"chromium.linux\", \"path_config\": \"generic\", \"recipe\": \"swarming/deterministic_build\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"bef6b6b3a36f5a13161c7b5d4340b1285725ce0d\"}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_3d74f5cea4cbf91e4b26f92a522c5c74e61b738440ef29ba16f5c9a596a5b201_v2\", \"builder_78902ab2d70d1593a97658cf8910c0e117cf7950e257117b8c551c6fe1cfb403_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"8\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Haswell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"luci-chromium-ci-xenial-us-central1-b-8-88-b78w\"], \"image\": [\"chrome-xenial-20052400-59eb8623c93\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"e2-standard-8\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-16.04\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.12\"], \"server_version\": [\"5218-123b763\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1592953146249863",
"status": "COMPLETED",
"status_changed_ts": "1592961090532246",
"tags": [
"build_address:luci.chromium.ci/Deterministic Linux/28291",
"builder:Deterministic Linux",
"buildset:commit/git/bef6b6b3a36f5a13161c7b5d4340b1285725ce0d",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/bef6b6b3a36f5a13161c7b5d4340b1285725ce0d",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9042091506225944064",
"scheduler_job_id:chromium/Deterministic Linux",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8876661444103334160/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:os:Linux",
"swarming_tag:recipe_name:swarming/deterministic_build",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:4cfc397e5cc7ef10",
"user_agent:luci-scheduler"
],
"updated_ts": "1592961090548609",
"url": "https://ci.chromium.org/b/8876661444103334160",
"utcnow_ts": "1592961091057085"
}
}
[01:11:31.083] Invocation finished in 2h15m4.957951167s with status SUCCEEDED