[03:43:20.885] New invocation is queued and will start shortly
[03:43:22.353] Starting the invocation (attempt 1)
[03:43:22.403] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[03:43:22.403] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[03:43:22.403] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9063091951473547200",
"parameters_json": "{\"builder_name\":\"Deterministic Linux\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"21f4904a741be132663360f7400e9b3c052d33df\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:Deterministic Linux",
"scheduler_invocation_id:9063091951473547200",
"scheduler_job_id:chromium/Deterministic Linux",
"user_agent:luci-scheduler",
"buildset:commit/git/21f4904a741be132663360f7400e9b3c052d33df",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/21f4904a741be132663360f7400e9b3c052d33df",
"gitiles_ref:refs/heads/master"
]
}
[03:43:23.984] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1572925402709318",
"id": "8897661888887710336",
"parameters_json": "{\"builder_name\": \"Deterministic Linux\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"21f4904a741be132663360f7400e9b3c052d33df\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1572925403144999",
"tags": [
"build_address:luci.chromium.ci/Deterministic Linux/25559",
"builder:Deterministic Linux",
"buildset:commit/git/21f4904a741be132663360f7400e9b3c052d33df",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/21f4904a741be132663360f7400e9b3c052d33df",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9063091951473547200",
"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/8897661888887710336/+/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": "1572925403145079",
"url": "https://ci.chromium.org/b/8897661888887710336",
"utcnow_ts": "1572925403965656"
}
}
[03:43:23.984] Task URL: https://ci.chromium.org/b/8897661888887710336
[03:43:23.984] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:2:0) after 1m0s
[03:43:37.889] Received PubSub notification, asking Buildbucket for the build status
[03:43:38.283] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:44:24.005] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:2:0)
[03:44:24.005] Timer tick, asking Buildbucket for the build status
[03:44:24.496] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:44:24.496] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:4:0) after 1m0s
[03:45:24.532] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:4:0)
[03:45:24.532] Timer tick, asking Buildbucket for the build status
[03:45:25.461] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:45:25.461] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:5:0) after 1m0s
[03:46:25.531] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:5:0)
[03:46:25.531] Timer tick, asking Buildbucket for the build status
[03:46:25.759] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:46:25.759] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:6:0) after 1m0s
[03:47:25.786] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:6:0)
[03:47:25.786] Timer tick, asking Buildbucket for the build status
[03:47:26.216] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:47:26.216] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:7:0) after 1m0s
[03:48:26.237] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:7:0)
[03:48:26.237] Timer tick, asking Buildbucket for the build status
[03:48:26.412] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:48:26.412] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:8:0) after 1m0s
[03:49:26.501] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:8:0)
[03:49:26.501] Timer tick, asking Buildbucket for the build status
[03:49:26.666] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:49:26.666] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:9:0) after 1m0s
[03:50:26.755] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:9:0)
[03:50:26.755] Timer tick, asking Buildbucket for the build status
[03:50:26.991] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:50:26.991] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:10:0) after 1m0s
[03:51:27.104] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:10:0)
[03:51:27.104] Timer tick, asking Buildbucket for the build status
[03:51:27.429] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:51:27.429] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:11:0) after 1m0s
[03:52:27.464] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:11:0)
[03:52:27.464] Timer tick, asking Buildbucket for the build status
[03:52:27.940] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:52:27.940] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:12:0) after 1m0s
[03:53:28.005] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:12:0)
[03:53:28.009] Timer tick, asking Buildbucket for the build status
[03:53:28.220] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:53:28.220] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:13:0) after 1m0s
[03:54:28.240] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:13:0)
[03:54:28.240] Timer tick, asking Buildbucket for the build status
[03:54:29.478] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:54:29.478] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:14:0) after 1m0s
[03:55:29.510] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:14:0)
[03:55:29.510] Timer tick, asking Buildbucket for the build status
[03:55:29.711] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:55:29.712] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:15:0) after 1m0s
[03:56:29.882] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:15:0)
[03:56:29.882] Timer tick, asking Buildbucket for the build status
[03:56:30.055] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:56:30.055] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:16:0) after 1m0s
[03:57:30.143] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:16:0)
[03:57:30.143] Timer tick, asking Buildbucket for the build status
[03:57:30.908] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:57:30.908] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:17:0) after 1m0s
[03:58:31.110] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:17:0)
[03:58:31.110] Timer tick, asking Buildbucket for the build status
[03:58:31.636] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:58:31.636] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:18:0) after 1m0s
[03:59:31.721] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:18:0)
[03:59:31.721] Timer tick, asking Buildbucket for the build status
[03:59:31.966] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:59:31.966] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:19:0) after 1m0s
[04:00:31.994] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:19:0)
[04:00:31.994] Timer tick, asking Buildbucket for the build status
[04:00:32.709] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:00:32.709] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:20:0) after 1m0s
[04:01:32.828] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:20:0)
[04:01:32.828] Timer tick, asking Buildbucket for the build status
[04:01:33.228] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:01:33.228] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:21:0) after 1m0s
[04:02:33.264] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:21:0)
[04:02:33.264] Timer tick, asking Buildbucket for the build status
[04:02:33.442] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:02:33.442] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:22:0) after 1m0s
[04:03:33.471] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:22:0)
[04:03:33.471] Timer tick, asking Buildbucket for the build status
[04:03:33.774] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:03:33.774] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:23:0) after 1m0s
[04:04:33.878] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:23:0)
[04:04:33.878] Timer tick, asking Buildbucket for the build status
[04:04:34.808] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:04:34.808] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:24:0) after 1m0s
[04:05:34.879] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:24:0)
[04:05:34.879] Timer tick, asking Buildbucket for the build status
[04:05:35.315] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:05:35.315] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:25:0) after 1m0s
[04:06:35.342] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:25:0)
[04:06:35.342] Timer tick, asking Buildbucket for the build status
[04:06:35.548] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:06:35.548] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:26:0) after 1m0s
[04:07:35.605] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:26:0)
[04:07:35.605] Timer tick, asking Buildbucket for the build status
[04:07:35.831] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:07:35.831] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:27:0) after 1m0s
[04:08:35.868] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:27:0)
[04:08:35.868] Timer tick, asking Buildbucket for the build status
[04:08:36.171] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:08:36.171] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:28:0) after 1m0s
[04:09:36.219] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:28:0)
[04:09:36.219] Timer tick, asking Buildbucket for the build status
[04:09:36.448] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:09:36.448] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:29:0) after 1m0s
[04:10:36.469] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:29:0)
[04:10:36.469] Timer tick, asking Buildbucket for the build status
[04:10:36.876] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:10:36.876] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:30:0) after 1m0s
[04:11:36.884] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:30:0)
[04:11:36.884] Timer tick, asking Buildbucket for the build status
[04:11:37.173] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:11:37.173] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:31:0) after 1m0s
[04:12:37.227] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:31:0)
[04:12:37.227] Timer tick, asking Buildbucket for the build status
[04:12:37.805] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:12:37.805] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:32:0) after 1m0s
[04:13:37.993] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:32:0)
[04:13:37.993] Timer tick, asking Buildbucket for the build status
[04:13:38.779] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:13:38.779] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:33:0) after 1m0s
[04:14:38.831] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:33:0)
[04:14:38.831] Timer tick, asking Buildbucket for the build status
[04:14:42.859] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:14:42.859] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:34:0) after 1m0s
[04:15:42.912] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:34:0)
[04:15:42.912] Timer tick, asking Buildbucket for the build status
[04:15:43.994] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:15:43.994] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:35:0) after 1m0s
[04:16:44.073] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:35:0)
[04:16:44.073] Timer tick, asking Buildbucket for the build status
[04:16:44.492] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:16:44.492] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:36:0) after 1m0s
[04:17:44.647] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:36:0)
[04:17:44.647] Timer tick, asking Buildbucket for the build status
[04:17:44.931] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:17:44.931] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:37:0) after 1m0s
[04:18:44.993] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:37:0)
[04:18:44.993] Timer tick, asking Buildbucket for the build status
[04:18:45.135] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:18:45.135] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:38:0) after 1m0s
[04:19:45.162] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:38:0)
[04:19:45.162] Timer tick, asking Buildbucket for the build status
[04:19:45.476] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:19:45.476] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:39:0) after 1m0s
[04:20:45.504] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:39:0)
[04:20:45.504] Timer tick, asking Buildbucket for the build status
[04:20:45.678] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:20:45.678] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:40:0) after 1m0s
[04:21:45.783] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:40:0)
[04:21:45.783] Timer tick, asking Buildbucket for the build status
[04:21:46.028] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:21:46.029] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:41:0) after 1m0s
[04:22:46.046] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:41:0)
[04:22:46.046] Timer tick, asking Buildbucket for the build status
[04:22:47.016] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:22:47.016] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:42:0) after 1m0s
[04:23:47.014] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:42:0)
[04:23:47.014] Timer tick, asking Buildbucket for the build status
[04:23:47.219] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:23:47.219] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:43:0) after 1m0s
[04:24:47.260] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:43:0)
[04:24:47.260] Timer tick, asking Buildbucket for the build status
[04:24:47.541] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:24:47.541] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:44:0) after 1m0s
[04:25:47.600] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:44:0)
[04:25:47.600] Timer tick, asking Buildbucket for the build status
[04:25:48.035] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:25:48.035] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:45:0) after 1m0s
[04:26:48.095] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:45:0)
[04:26:48.095] Timer tick, asking Buildbucket for the build status
[04:26:48.334] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:26:48.334] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:46:0) after 1m0s
[04:27:48.468] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:46:0)
[04:27:48.468] Timer tick, asking Buildbucket for the build status
[04:27:48.771] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:27:48.771] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:47:0) after 1m0s
[04:28:48.914] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:47:0)
[04:28:48.914] Timer tick, asking Buildbucket for the build status
[04:28:49.360] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:28:49.360] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:48:0) after 1m0s
[04:29:49.384] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:48:0)
[04:29:49.384] Timer tick, asking Buildbucket for the build status
[04:29:49.720] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:29:49.720] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:49:0) after 1m0s
[04:30:49.750] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:49:0)
[04:30:49.750] Timer tick, asking Buildbucket for the build status
[04:30:50.116] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:30:50.116] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:50:0) after 1m0s
[04:31:50.291] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:50:0)
[04:31:50.291] Timer tick, asking Buildbucket for the build status
[04:31:50.584] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:31:50.584] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:51:0) after 1m0s
[04:32:50.676] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:51:0)
[04:32:50.676] Timer tick, asking Buildbucket for the build status
[04:32:50.829] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:32:50.829] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:52:0) after 1m0s
[04:33:50.922] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:52:0)
[04:33:50.922] Timer tick, asking Buildbucket for the build status
[04:33:51.221] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:33:51.221] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:53:0) after 1m0s
[04:34:51.631] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:53:0)
[04:34:51.631] Timer tick, asking Buildbucket for the build status
[04:34:52.204] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:34:52.204] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:54:0) after 1m0s
[04:35:52.283] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:54:0)
[04:35:52.283] Timer tick, asking Buildbucket for the build status
[04:35:52.509] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:35:52.509] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:55:0) after 1m0s
[04:36:52.585] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:55:0)
[04:36:52.585] Timer tick, asking Buildbucket for the build status
[04:36:53.014] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:36:53.014] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:56:0) after 1m0s
[04:37:53.042] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:56:0)
[04:37:53.042] Timer tick, asking Buildbucket for the build status
[04:37:53.374] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:37:53.374] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:57:0) after 1m0s
[04:38:53.474] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:57:0)
[04:38:53.474] Timer tick, asking Buildbucket for the build status
[04:38:53.778] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:38:53.778] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:58:0) after 1m0s
[04:39:53.832] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:58:0)
[04:39:53.832] Timer tick, asking Buildbucket for the build status
[04:39:55.628] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:39:55.628] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:59:0) after 1m0s
[04:40:55.692] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:59:0)
[04:40:55.692] Timer tick, asking Buildbucket for the build status
[04:40:55.845] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:40:55.845] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:60:0) after 1m0s
[04:41:55.879] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:60:0)
[04:41:55.879] Timer tick, asking Buildbucket for the build status
[04:41:56.174] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:41:56.174] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:61:0) after 1m0s
[04:42:56.262] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:61:0)
[04:42:56.262] Timer tick, asking Buildbucket for the build status
[04:42:56.833] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:42:56.833] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:62:0) after 1m0s
[04:43:56.877] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:62:0)
[04:43:56.877] Timer tick, asking Buildbucket for the build status
[04:43:57.240] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:43:57.240] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:63:0) after 1m0s
[04:44:57.317] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:63:0)
[04:44:57.317] Timer tick, asking Buildbucket for the build status
[04:44:57.487] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:44:57.487] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:64:0) after 1m0s
[04:45:57.527] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:64:0)
[04:45:57.527] Timer tick, asking Buildbucket for the build status
[04:45:57.888] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:45:57.888] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:65:0) after 1m0s
[04:46:57.915] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:65:0)
[04:46:57.915] Timer tick, asking Buildbucket for the build status
[04:46:58.489] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:46:58.489] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:66:0) after 1m0s
[04:47:58.522] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:66:0)
[04:47:58.522] Timer tick, asking Buildbucket for the build status
[04:47:59.374] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:47:59.374] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:67:0) after 1m0s
[04:48:59.422] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:67:0)
[04:48:59.422] Timer tick, asking Buildbucket for the build status
[04:48:59.621] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:48:59.621] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:68:0) after 1m0s
[04:49:59.678] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:68:0)
[04:49:59.678] Timer tick, asking Buildbucket for the build status
[04:50:00.870] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:50:00.870] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:69:0) after 1m0s
[04:51:00.923] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:69:0)
[04:51:00.923] Timer tick, asking Buildbucket for the build status
[04:51:01.867] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:51:01.867] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:70:0) after 1m0s
[04:52:01.930] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:70:0)
[04:52:01.930] Timer tick, asking Buildbucket for the build status
[04:52:02.822] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:52:02.822] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:71:0) after 1m0s
[04:53:02.872] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:71:0)
[04:53:02.872] Timer tick, asking Buildbucket for the build status
[04:53:03.066] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:53:03.066] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:72:0) after 1m0s
[04:54:03.103] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:72:0)
[04:54:03.103] Timer tick, asking Buildbucket for the build status
[04:54:03.281] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:54:03.281] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:73:0) after 1m0s
[04:55:03.388] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:73:0)
[04:55:03.388] Timer tick, asking Buildbucket for the build status
[04:55:03.557] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:55:03.557] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:74:0) after 1m0s
[04:56:03.616] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:74:0)
[04:56:03.616] Timer tick, asking Buildbucket for the build status
[04:56:03.796] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:56:03.796] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:75:0) after 1m0s
[04:57:03.830] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:75:0)
[04:57:03.830] Timer tick, asking Buildbucket for the build status
[04:57:04.026] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:57:04.026] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:76:0) after 1m0s
[04:58:04.056] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:76:0)
[04:58:04.057] Timer tick, asking Buildbucket for the build status
[04:58:04.235] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:58:04.235] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:77:0) after 1m0s
[04:59:04.361] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:77:0)
[04:59:04.361] Timer tick, asking Buildbucket for the build status
[04:59:04.527] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:59:04.528] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:78:0) after 1m0s
[05:00:04.597] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:78:0)
[05:00:04.597] Timer tick, asking Buildbucket for the build status
[05:00:05.357] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:00:05.357] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:79:0) after 1m0s
[05:01:05.434] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:79:0)
[05:01:05.434] Timer tick, asking Buildbucket for the build status
[05:01:05.599] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:01:05.599] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:80:0) after 1m0s
[05:02:05.626] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:80:0)
[05:02:05.626] Timer tick, asking Buildbucket for the build status
[05:02:05.899] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:02:05.899] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:81:0) after 1m0s
[05:03:05.925] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:81:0)
[05:03:05.925] Timer tick, asking Buildbucket for the build status
[05:03:06.576] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:03:06.576] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:82:0) after 1m0s
[05:04:06.608] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:82:0)
[05:04:06.608] Timer tick, asking Buildbucket for the build status
[05:04:06.825] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:04:06.825] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:83:0) after 1m0s
[05:05:06.936] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:83:0)
[05:05:06.936] Timer tick, asking Buildbucket for the build status
[05:05:07.409] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:05:07.409] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:84:0) after 1m0s
[05:06:07.433] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:84:0)
[05:06:07.433] Timer tick, asking Buildbucket for the build status
[05:06:07.697] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:06:07.697] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:85:0) after 1m0s
[05:07:07.722] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:85:0)
[05:07:07.722] Timer tick, asking Buildbucket for the build status
[05:07:08.696] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:07:08.696] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:86:0) after 1m0s
[05:08:08.723] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:86:0)
[05:08:08.723] Timer tick, asking Buildbucket for the build status
[05:08:08.906] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:08:08.906] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:87:0) after 1m0s
[05:09:08.965] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:87:0)
[05:09:08.965] Timer tick, asking Buildbucket for the build status
[05:09:09.567] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:09:09.567] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:88:0) after 1m0s
[05:10:09.705] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:88:0)
[05:10:09.705] Timer tick, asking Buildbucket for the build status
[05:10:10.207] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:10:10.207] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:89:0) after 1m0s
[05:11:10.244] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:89:0)
[05:11:10.244] Timer tick, asking Buildbucket for the build status
[05:11:10.432] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:11:10.432] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:90:0) after 1m0s
[05:12:10.645] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:90:0)
[05:12:10.645] Timer tick, asking Buildbucket for the build status
[05:12:10.834] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:12:10.834] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:91:0) after 1m0s
[05:13:10.952] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:91:0)
[05:13:10.952] Timer tick, asking Buildbucket for the build status
[05:13:11.115] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:13:11.115] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:92:0) after 1m0s
[05:14:11.142] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:92:0)
[05:14:11.142] Timer tick, asking Buildbucket for the build status
[05:14:11.288] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:14:11.288] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:93:0) after 1m0s
[05:15:11.356] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:93:0)
[05:15:11.356] Timer tick, asking Buildbucket for the build status
[05:15:11.755] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:15:11.755] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:94:0) after 1m0s
[05:16:11.813] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:94:0)
[05:16:11.813] Timer tick, asking Buildbucket for the build status
[05:16:11.976] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:16:11.976] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:95:0) after 1m0s
[05:17:12.026] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:95:0)
[05:17:12.026] Timer tick, asking Buildbucket for the build status
[05:17:12.587] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:17:12.587] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:96:0) after 1m0s
[05:18:12.618] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:96:0)
[05:18:12.618] Timer tick, asking Buildbucket for the build status
[05:18:12.892] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:18:12.892] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:97:0) after 1m0s
[05:19:12.955] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:97:0)
[05:19:12.955] Timer tick, asking Buildbucket for the build status
[05:19:13.129] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:19:13.129] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:98:0) after 1m0s
[05:20:13.197] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:98:0)
[05:20:13.197] Timer tick, asking Buildbucket for the build status
[05:20:14.146] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:20:14.146] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:99:0) after 1m0s
[05:21:14.428] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:99:0)
[05:21:14.428] Timer tick, asking Buildbucket for the build status
[05:21:14.877] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:21:14.877] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:100:0) after 1m0s
[05:22:14.918] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:100:0)
[05:22:14.918] Timer tick, asking Buildbucket for the build status
[05:22:15.148] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:22:15.148] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:101:0) after 1m0s
[05:23:15.205] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:101:0)
[05:23:15.205] Timer tick, asking Buildbucket for the build status
[05:23:15.812] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:23:15.812] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:102:0) after 1m0s
[05:24:15.840] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:102:0)
[05:24:15.840] Timer tick, asking Buildbucket for the build status
[05:24:16.783] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:24:16.783] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:103:0) after 1m0s
[05:25:16.871] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:103:0)
[05:25:16.871] Timer tick, asking Buildbucket for the build status
[05:25:17.057] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:25:17.057] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:104:0) after 1m0s
[05:26:17.093] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:104:0)
[05:26:17.093] Timer tick, asking Buildbucket for the build status
[05:26:17.577] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:26:17.577] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:105:0) after 1m0s
[05:27:17.654] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:105:0)
[05:27:17.654] Timer tick, asking Buildbucket for the build status
[05:27:18.698] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:27:18.698] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:106:0) after 1m0s
[05:28:18.861] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:106:0)
[05:28:18.861] Timer tick, asking Buildbucket for the build status
[05:28:19.884] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:28:19.884] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:107:0) after 1m0s
[05:29:20.043] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:107:0)
[05:29:20.043] Timer tick, asking Buildbucket for the build status
[05:29:20.467] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:29:20.467] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:108:0) after 1m0s
[05:30:20.556] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:108:0)
[05:30:20.556] Timer tick, asking Buildbucket for the build status
[05:30:21.073] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:30:21.073] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:109:0) after 1m0s
[05:31:21.160] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:109:0)
[05:31:21.160] Timer tick, asking Buildbucket for the build status
[05:31:21.763] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:31:21.763] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:110:0) after 1m0s
[05:32:21.832] Handling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:110:0)
[05:32:21.832] Timer tick, asking Buildbucket for the build status
[05:32:22.093] Build 8897661888887710336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:32:22.094] Scheduling timer "check-buildbucket-build-status" (chromium/Deterministic Linux:9063091951473547200:111:0) after 1m0s
[05:33:15.791] Received PubSub notification, asking Buildbucket for the build status
[05:33:15.960] Build 8897661888887710336: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[05:33:15.960] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1572931995115559",
"created_by": "project:chromium",
"created_ts": "1572925402709318",
"id": "8897661888887710336",
"parameters_json": "{\"builder_name\": \"Deterministic Linux\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"21f4904a741be132663360f7400e9b3c052d33df\"}}",
"project": "chromium",
"result": "SUCCESS",
"result_details_json": "{\"properties\": {\"$build/goma\": {\"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-101-s45v\", \"branch\": \"refs/heads/master\", \"buildername\": \"Deterministic Linux\", \"buildnumber\": 25559, \"got_angle_revision\": \"71b0f0b588d64b5be77c6bb5f2e9cac6990a72b1\", \"got_dawn_revision\": \"6df81ebf1dcf133c6bac7d2c208401b2c072b06d\", \"got_nacl_revision\": \"3651f6c52037c96e034cc422746768d59182bff3\", \"got_revision\": \"21f4904a741be132663360f7400e9b3c052d33df\", \"got_revision_cp\": \"refs/heads/master@{#712438}\", \"got_swarming_client_revision\": \"885b3febcc170a60f25795304e60927b77d1e92d\", \"got_swiftshader_revision\": \"aaa64b76c0b40c2958a18cfdc623157c8c6e1b7d\", \"got_v8_revision\": \"d3f9d9a2d1a98fc4362b8f0e42f63ca50573f1dc\", \"got_v8_revision_cp\": \"refs/heads/8.0.155@{#1}\", \"got_webrtc_revision\": \"ca585bb45729beacc3280fb5008ddf3dc00f1884\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#29684}\", \"mastername\": \"chromium.linux\", \"path_config\": \"generic\", \"recipe\": \"swarming/deterministic_build\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"21f4904a741be132663360f7400e9b3c052d33df\"}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_2e9fdac7759932c89734e16e81a06fc7290a8f21b8b502c8ac5f4bb6f29f7fe5_v2\", \"builder_78902ab2d70d1593a97658cf8910c0e117cf7950e257117b8c551c6fe1cfb403_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"8\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gpu\": [\"none\"], \"id\": [\"luci-chromium-ci-xenial-us-central1-b-8-101-s45v\"], \"image\": [\"chrome-xenial-19102400-d35fedf5a0d\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"n1-standard-8\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-16.04\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.12\"], \"server_version\": [\"4621-f8a5b1c\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1572925416857258",
"status": "COMPLETED",
"status_changed_ts": "1572931995417643",
"tags": [
"build_address:luci.chromium.ci/Deterministic Linux/25559",
"builder:Deterministic Linux",
"buildset:commit/git/21f4904a741be132663360f7400e9b3c052d33df",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/21f4904a741be132663360f7400e9b3c052d33df",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9063091951473547200",
"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/8897661888887710336/+/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:48527aa713826e10",
"user_agent:luci-scheduler"
],
"updated_ts": "1572931995420969",
"url": "https://ci.chromium.org/b/8897661888887710336",
"utcnow_ts": "1572931995951417"
}
}
[05:33:15.960] Invocation finished in 1h49m55.100169909s with status SUCCEEDED