[07:33:03.227] New invocation is queued and will start shortly
[07:33:03.227] Triggered by user:chromium-tarball-builder@chops-service-accounts.iam.gserviceaccount.com
[07:33:04.324] Starting the invocation (attempt 1)
[07:33:04.453] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[07:33:04.453] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[07:33:04.453] Buildbucket request:
{
"bucket": "luci.infra.cron",
"client_operation_id": "9051299893999281056",
"parameters_json": "{\"builder_name\":\"Build From Tarball\",\"properties\":{\"$recipe_engine/scheduler\":{\"hostname\":\"luci-scheduler.appspot.com\",\"triggers\":[{\"buildbucket\":{\"properties\":{\"version\":\"82.0.4085.4\"},\"tags\":[\"parent_buildername:publish_tarball\",\"user_agent:recipe\"]},\"id\":\"384a179e-c3ec-4a15-82d8-726f0f8dfd3d\",\"title\":\"publish_tarball/0\"}]},\"version\":\"82.0.4085.4\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:Build From Tarball",
"scheduler_invocation_id:9051299893999281056",
"scheduler_job_id:infra/Build From Tarball",
"user_agent:luci-scheduler",
"parent_buildername:publish_tarball",
"user_agent:recipe"
]
}
[07:33:04.973] Buildbucket response:
{
"build": {
"bucket": "luci.infra.cron",
"canary_preference": "PROD",
"created_by": "project:infra",
"created_ts": "1584171184634415",
"id": "8885869831859788688",
"parameters_json": "{\"builder_name\": \"Build From Tarball\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"buildbucket\": {\"properties\": {\"version\": \"82.0.4085.4\"}, \"tags\": [\"parent_buildername:publish_tarball\", \"user_agent:recipe\"]}, \"id\": \"384a179e-c3ec-4a15-82d8-726f0f8dfd3d\", \"title\": \"publish_tarball/0\"}]}, \"version\": \"82.0.4085.4\"}}",
"project": "infra",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-tarball-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1584171184824117",
"tags": [
"builder:Build From Tarball",
"parent_buildername:publish_tarball",
"scheduler_invocation_id:9051299893999281056",
"scheduler_job_id:infra/Build From Tarball",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/infra/buildbucket/cr-buildbucket.appspot.com/8885869831859788688/+/annotations",
"swarming_tag:luci_project:infra",
"swarming_tag:recipe_name:build_from_tarball",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/infra/infra",
"swarming_task_id:",
"user_agent:luci-scheduler",
"user_agent:recipe"
],
"updated_ts": "1584171184824219",
"url": "https://ci.chromium.org/b/8885869831859788688",
"utcnow_ts": "1584171184958883"
}
}
[07:33:04.973] Task URL: https://ci.chromium.org/b/8885869831859788688
[07:33:04.973] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:2:0) after 1m0s
[07:34:05.567] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:2:0)
[07:34:05.567] Timer tick, asking Buildbucket for the build status
[07:34:05.688] Build 8885869831859788688: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:34:05.688] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:3:0) after 1m0s
[07:34:12.006] Received PubSub notification, asking Buildbucket for the build status
[07:34:12.145] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:35:05.683] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:3:0)
[07:35:05.683] Timer tick, asking Buildbucket for the build status
[07:35:05.872] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:35:05.872] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:5:0) after 1m0s
[07:36:05.900] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:5:0)
[07:36:05.900] Timer tick, asking Buildbucket for the build status
[07:36:06.125] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:36:06.125] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:6:0) after 1m0s
[07:37:06.142] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:6:0)
[07:37:06.142] Timer tick, asking Buildbucket for the build status
[07:37:06.313] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:37:06.313] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:7:0) after 1m0s
[07:38:06.352] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:7:0)
[07:38:06.353] Timer tick, asking Buildbucket for the build status
[07:38:06.485] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:38:06.485] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:8:0) after 1m0s
[07:39:06.573] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:8:0)
[07:39:06.573] Timer tick, asking Buildbucket for the build status
[07:39:06.825] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:39:06.825] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:9:0) after 1m0s
[07:40:06.960] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:9:0)
[07:40:06.960] Timer tick, asking Buildbucket for the build status
[07:40:07.069] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:40:07.069] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:10:0) after 1m0s
[07:41:07.159] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:10:0)
[07:41:07.159] Timer tick, asking Buildbucket for the build status
[07:41:07.548] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:41:07.548] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:11:0) after 1m0s
[07:42:07.535] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:11:0)
[07:42:07.535] Timer tick, asking Buildbucket for the build status
[07:42:07.618] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:42:07.619] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:12:0) after 1m0s
[07:43:07.720] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:12:0)
[07:43:07.720] Timer tick, asking Buildbucket for the build status
[07:43:07.806] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:43:07.806] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:13:0) after 1m0s
[07:44:07.832] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:13:0)
[07:44:07.832] Timer tick, asking Buildbucket for the build status
[07:44:08.074] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:44:08.074] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:14:0) after 1m0s
[07:45:08.298] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:14:0)
[07:45:08.298] Timer tick, asking Buildbucket for the build status
[07:45:08.470] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:45:08.470] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:15:0) after 1m0s
[07:46:08.546] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:15:0)
[07:46:08.546] Timer tick, asking Buildbucket for the build status
[07:46:08.817] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:46:08.817] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:16:0) after 1m0s
[07:47:08.904] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:16:0)
[07:47:08.904] Timer tick, asking Buildbucket for the build status
[07:47:09.105] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:47:09.105] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:17:0) after 1m0s
[07:48:09.241] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:17:0)
[07:48:09.241] Timer tick, asking Buildbucket for the build status
[07:48:09.462] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:48:09.462] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:18:0) after 1m0s
[07:49:09.745] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:18:0)
[07:49:09.745] Timer tick, asking Buildbucket for the build status
[07:49:10.043] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:49:10.043] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:19:0) after 1m0s
[07:50:10.114] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:19:0)
[07:50:10.114] Timer tick, asking Buildbucket for the build status
[07:50:10.202] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:50:10.202] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:20:0) after 1m0s
[07:51:10.280] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:20:0)
[07:51:10.280] Timer tick, asking Buildbucket for the build status
[07:51:10.402] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:51:10.402] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:21:0) after 1m0s
[07:52:10.423] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:21:0)
[07:52:10.423] Timer tick, asking Buildbucket for the build status
[07:52:10.552] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:52:10.552] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:22:0) after 1m0s
[07:53:10.603] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:22:0)
[07:53:10.603] Timer tick, asking Buildbucket for the build status
[07:53:10.723] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:53:10.725] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:23:0) after 1m0s
[07:54:10.818] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:23:0)
[07:54:10.819] Timer tick, asking Buildbucket for the build status
[07:54:10.966] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:54:10.966] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:24:0) after 1m0s
[07:55:11.059] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:24:0)
[07:55:11.059] Timer tick, asking Buildbucket for the build status
[07:55:11.226] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:55:11.226] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:25:0) after 1m0s
[07:56:11.246] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:25:0)
[07:56:11.246] Timer tick, asking Buildbucket for the build status
[07:56:11.366] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:56:11.366] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:26:0) after 1m0s
[07:57:11.388] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:26:0)
[07:57:11.388] Timer tick, asking Buildbucket for the build status
[07:57:11.527] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:57:11.527] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:27:0) after 1m0s
[07:58:11.512] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:27:0)
[07:58:11.512] Timer tick, asking Buildbucket for the build status
[07:58:11.905] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:58:11.905] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:28:0) after 1m0s
[07:59:11.931] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:28:0)
[07:59:11.931] Timer tick, asking Buildbucket for the build status
[07:59:12.062] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:59:12.062] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:29:0) after 1m0s
[08:00:12.088] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:29:0)
[08:00:12.088] Timer tick, asking Buildbucket for the build status
[08:00:12.614] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:00:12.614] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:30:0) after 1m0s
[08:01:12.615] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:30:0)
[08:01:12.615] Timer tick, asking Buildbucket for the build status
[08:01:12.875] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:01:12.875] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:31:0) after 1m0s
[08:02:12.900] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:31:0)
[08:02:12.900] Timer tick, asking Buildbucket for the build status
[08:02:13.011] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:02:13.011] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:32:0) after 1m0s
[08:03:13.100] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:32:0)
[08:03:13.100] Timer tick, asking Buildbucket for the build status
[08:03:13.263] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:03:13.263] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:33:0) after 1m0s
[08:04:13.294] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:33:0)
[08:04:13.294] Timer tick, asking Buildbucket for the build status
[08:04:13.453] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:04:13.453] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:34:0) after 1m0s
[08:05:13.481] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:34:0)
[08:05:13.481] Timer tick, asking Buildbucket for the build status
[08:05:13.867] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:05:13.867] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:35:0) after 1m0s
[08:06:13.883] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:35:0)
[08:06:13.883] Timer tick, asking Buildbucket for the build status
[08:06:14.091] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:06:14.091] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:36:0) after 1m0s
[08:07:14.150] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:36:0)
[08:07:14.150] Timer tick, asking Buildbucket for the build status
[08:07:14.266] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:07:14.266] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:37:0) after 1m0s
[08:08:14.351] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:37:0)
[08:08:14.351] Timer tick, asking Buildbucket for the build status
[08:08:14.524] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:08:14.524] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:38:0) after 1m0s
[08:09:14.556] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:38:0)
[08:09:14.556] Timer tick, asking Buildbucket for the build status
[08:09:14.784] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:09:14.784] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:39:0) after 1m0s
[08:10:14.884] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:39:0)
[08:10:14.884] Timer tick, asking Buildbucket for the build status
[08:10:15.028] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:10:15.028] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:40:0) after 1m0s
[08:11:15.051] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:40:0)
[08:11:15.051] Timer tick, asking Buildbucket for the build status
[08:11:15.339] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:11:15.339] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:41:0) after 1m0s
[08:12:15.368] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:41:0)
[08:12:15.368] Timer tick, asking Buildbucket for the build status
[08:12:15.511] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:12:15.511] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:42:0) after 1m0s
[08:13:15.531] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:42:0)
[08:13:15.531] Timer tick, asking Buildbucket for the build status
[08:13:16.092] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:13:16.092] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:43:0) after 1m0s
[08:14:16.158] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:43:0)
[08:14:16.158] Timer tick, asking Buildbucket for the build status
[08:14:16.285] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:14:16.285] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:44:0) after 1m0s
[08:15:16.311] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:44:0)
[08:15:16.311] Timer tick, asking Buildbucket for the build status
[08:15:16.462] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:15:16.462] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:45:0) after 1m0s
[08:16:16.450] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:45:0)
[08:16:16.450] Timer tick, asking Buildbucket for the build status
[08:16:16.593] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:16:16.593] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:46:0) after 1m0s
[08:17:16.618] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:46:0)
[08:17:16.618] Timer tick, asking Buildbucket for the build status
[08:17:16.842] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:17:16.842] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:47:0) after 1m0s
[08:18:16.865] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:47:0)
[08:18:16.865] Timer tick, asking Buildbucket for the build status
[08:18:17.114] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:18:17.114] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:48:0) after 1m0s
[08:19:17.146] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:48:0)
[08:19:17.146] Timer tick, asking Buildbucket for the build status
[08:19:17.437] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:19:17.437] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:49:0) after 1m0s
[08:20:17.456] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:49:0)
[08:20:17.456] Timer tick, asking Buildbucket for the build status
[08:20:17.588] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:20:17.588] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:50:0) after 1m0s
[08:21:17.613] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:50:0)
[08:21:17.613] Timer tick, asking Buildbucket for the build status
[08:21:17.780] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:21:17.780] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:51:0) after 1m0s
[08:22:17.855] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:51:0)
[08:22:17.855] Timer tick, asking Buildbucket for the build status
[08:22:18.145] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:22:18.145] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:52:0) after 1m0s
[08:23:18.187] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:52:0)
[08:23:18.187] Timer tick, asking Buildbucket for the build status
[08:23:18.296] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:23:18.296] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:53:0) after 1m0s
[08:24:18.401] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:53:0)
[08:24:18.401] Timer tick, asking Buildbucket for the build status
[08:24:18.610] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:24:18.610] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:54:0) after 1m0s
[08:25:18.658] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:54:0)
[08:25:18.658] Timer tick, asking Buildbucket for the build status
[08:25:18.820] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:25:18.820] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:55:0) after 1m0s
[08:26:18.840] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:55:0)
[08:26:18.840] Timer tick, asking Buildbucket for the build status
[08:26:18.999] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:26:18.999] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:56:0) after 1m0s
[08:27:19.335] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:56:0)
[08:27:19.335] Timer tick, asking Buildbucket for the build status
[08:27:19.576] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:27:19.576] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:57:0) after 1m0s
[08:28:19.618] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:57:0)
[08:28:19.618] Timer tick, asking Buildbucket for the build status
[08:28:20.140] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:28:20.140] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:58:0) after 1m0s
[08:29:20.182] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:58:0)
[08:29:20.182] Timer tick, asking Buildbucket for the build status
[08:29:20.298] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:29:20.298] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:59:0) after 1m0s
[08:30:20.394] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:59:0)
[08:30:20.394] Timer tick, asking Buildbucket for the build status
[08:30:20.610] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:30:20.611] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:60:0) after 1m0s
[08:31:20.670] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:60:0)
[08:31:20.670] Timer tick, asking Buildbucket for the build status
[08:31:21.068] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:31:21.068] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:61:0) after 1m0s
[08:32:21.092] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:61:0)
[08:32:21.092] Timer tick, asking Buildbucket for the build status
[08:32:21.292] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:32:21.292] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:62:0) after 1m0s
[08:33:21.503] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:62:0)
[08:33:21.503] Timer tick, asking Buildbucket for the build status
[08:33:21.727] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:33:21.727] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:63:0) after 1m0s
[08:34:21.914] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:63:0)
[08:34:21.914] Timer tick, asking Buildbucket for the build status
[08:34:22.764] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:34:22.764] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:64:0) after 1m0s
[08:35:22.829] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:64:0)
[08:35:22.829] Timer tick, asking Buildbucket for the build status
[08:35:22.943] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:35:22.943] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:65:0) after 1m0s
[08:36:22.960] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:65:0)
[08:36:22.960] Timer tick, asking Buildbucket for the build status
[08:36:23.114] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:36:23.114] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:66:0) after 1m0s
[08:37:23.176] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:66:0)
[08:37:23.176] Timer tick, asking Buildbucket for the build status
[08:37:23.808] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:37:23.808] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:67:0) after 1m0s
[08:38:23.924] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:67:0)
[08:38:23.924] Timer tick, asking Buildbucket for the build status
[08:38:24.156] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:38:24.156] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:68:0) after 1m0s
[08:39:24.205] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:68:0)
[08:39:24.205] Timer tick, asking Buildbucket for the build status
[08:39:25.125] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:39:25.125] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:69:0) after 1m0s
[08:40:25.148] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:69:0)
[08:40:25.148] Timer tick, asking Buildbucket for the build status
[08:40:25.271] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:40:25.271] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:70:0) after 1m0s
[08:41:25.989] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:70:0)
[08:41:25.989] Timer tick, asking Buildbucket for the build status
[08:41:26.525] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:41:26.525] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:71:0) after 1m0s
[08:42:26.523] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:71:0)
[08:42:26.523] Timer tick, asking Buildbucket for the build status
[08:42:26.654] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:42:26.654] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:72:0) after 1m0s
[08:43:26.690] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:72:0)
[08:43:26.690] Timer tick, asking Buildbucket for the build status
[08:43:26.823] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:43:26.823] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:73:0) after 1m0s
[08:44:26.859] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:73:0)
[08:44:26.859] Timer tick, asking Buildbucket for the build status
[08:44:27.609] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:44:27.609] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:74:0) after 1m0s
[08:45:27.650] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:74:0)
[08:45:27.650] Timer tick, asking Buildbucket for the build status
[08:45:27.958] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:45:27.958] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:75:0) after 1m0s
[08:46:28.029] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:75:0)
[08:46:28.029] Timer tick, asking Buildbucket for the build status
[08:46:28.161] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:46:28.161] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:76:0) after 1m0s
[08:47:28.193] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:76:0)
[08:47:28.193] Timer tick, asking Buildbucket for the build status
[08:47:28.604] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:47:28.604] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:77:0) after 1m0s
[08:48:28.625] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:77:0)
[08:48:28.626] Timer tick, asking Buildbucket for the build status
[08:48:28.779] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:48:28.779] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:78:0) after 1m0s
[08:49:28.901] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:78:0)
[08:49:28.901] Timer tick, asking Buildbucket for the build status
[08:49:29.487] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:49:29.487] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:79:0) after 1m0s
[08:50:29.604] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:79:0)
[08:50:29.604] Timer tick, asking Buildbucket for the build status
[08:50:29.717] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:50:29.717] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:80:0) after 1m0s
[08:51:29.745] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:80:0)
[08:51:29.745] Timer tick, asking Buildbucket for the build status
[08:51:29.865] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:51:29.865] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:81:0) after 1m0s
[08:52:30.037] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:81:0)
[08:52:30.037] Timer tick, asking Buildbucket for the build status
[08:52:30.293] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:52:30.293] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:82:0) after 1m0s
[08:53:30.631] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:82:0)
[08:53:30.631] Timer tick, asking Buildbucket for the build status
[08:53:30.854] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:53:30.854] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:83:0) after 1m0s
[08:54:31.316] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:83:0)
[08:54:31.316] Timer tick, asking Buildbucket for the build status
[08:54:32.002] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:54:32.002] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:84:0) after 1m0s
[08:55:32.474] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:84:0)
[08:55:32.474] Timer tick, asking Buildbucket for the build status
[08:55:32.611] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:55:32.611] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:85:0) after 1m0s
[08:56:32.930] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:85:0)
[08:56:32.930] Timer tick, asking Buildbucket for the build status
[08:56:33.225] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:56:33.225] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:86:0) after 1m0s
[08:57:33.464] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:86:0)
[08:57:33.464] Timer tick, asking Buildbucket for the build status
[08:57:33.652] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:57:33.652] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:87:0) after 1m0s
[08:58:33.909] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:87:0)
[08:58:33.909] Timer tick, asking Buildbucket for the build status
[08:58:33.972] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:58:33.972] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:88:0) after 1m0s
[08:59:34.123] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:88:0)
[08:59:34.123] Timer tick, asking Buildbucket for the build status
[08:59:34.251] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:59:34.251] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:89:0) after 1m0s
[09:00:34.278] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:89:0)
[09:00:34.278] Timer tick, asking Buildbucket for the build status
[09:00:34.442] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:00:34.442] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:90:0) after 1m0s
[09:01:34.561] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:90:0)
[09:01:34.561] Timer tick, asking Buildbucket for the build status
[09:01:34.711] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:01:34.711] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:91:0) after 1m0s
[09:02:34.811] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:91:0)
[09:02:34.811] Timer tick, asking Buildbucket for the build status
[09:02:35.297] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:02:35.297] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:92:0) after 1m0s
[09:03:35.324] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:92:0)
[09:03:35.324] Timer tick, asking Buildbucket for the build status
[09:03:35.487] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:03:35.487] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:93:0) after 1m0s
[09:04:35.672] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:93:0)
[09:04:35.672] Timer tick, asking Buildbucket for the build status
[09:04:36.385] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:04:36.385] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:94:0) after 1m0s
[09:05:36.501] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:94:0)
[09:05:36.501] Timer tick, asking Buildbucket for the build status
[09:05:36.701] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:05:36.701] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:95:0) after 1m0s
[09:06:36.774] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:95:0)
[09:06:36.774] Timer tick, asking Buildbucket for the build status
[09:06:37.135] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:06:37.135] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:96:0) after 1m0s
[09:07:37.197] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:96:0)
[09:07:37.197] Timer tick, asking Buildbucket for the build status
[09:07:37.327] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:07:37.327] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:97:0) after 1m0s
[09:08:37.351] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:97:0)
[09:08:37.351] Timer tick, asking Buildbucket for the build status
[09:08:37.642] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:08:37.642] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:98:0) after 1m0s
[09:09:37.686] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:98:0)
[09:09:37.686] Timer tick, asking Buildbucket for the build status
[09:09:38.450] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:09:38.450] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:99:0) after 1m0s
[09:10:38.480] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:99:0)
[09:10:38.480] Timer tick, asking Buildbucket for the build status
[09:10:38.629] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:10:38.629] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:100:0) after 1m0s
[09:11:38.662] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:100:0)
[09:11:38.663] Timer tick, asking Buildbucket for the build status
[09:11:38.846] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:11:38.846] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:101:0) after 1m0s
[09:12:38.870] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:101:0)
[09:12:38.870] Timer tick, asking Buildbucket for the build status
[09:12:38.963] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:12:38.963] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:102:0) after 1m0s
[09:13:39.205] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:102:0)
[09:13:39.205] Timer tick, asking Buildbucket for the build status
[09:13:39.379] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:13:39.379] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:103:0) after 1m0s
[09:14:39.518] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:103:0)
[09:14:39.518] Timer tick, asking Buildbucket for the build status
[09:14:39.788] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:14:39.788] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:104:0) after 1m0s
[09:15:39.943] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:104:0)
[09:15:39.943] Timer tick, asking Buildbucket for the build status
[09:15:40.147] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:15:40.147] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:105:0) after 1m0s
[09:16:40.167] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:105:0)
[09:16:40.167] Timer tick, asking Buildbucket for the build status
[09:16:40.287] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:16:40.287] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:106:0) after 1m0s
[09:17:40.436] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:106:0)
[09:17:40.436] Timer tick, asking Buildbucket for the build status
[09:17:40.603] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:17:40.603] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:107:0) after 1m0s
[09:18:40.626] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:107:0)
[09:18:40.626] Timer tick, asking Buildbucket for the build status
[09:18:40.757] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:18:40.757] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:108:0) after 1m0s
[09:19:41.041] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:108:0)
[09:19:41.041] Timer tick, asking Buildbucket for the build status
[09:19:41.283] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:19:41.283] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:109:0) after 1m0s
[09:20:41.312] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:109:0)
[09:20:41.312] Timer tick, asking Buildbucket for the build status
[09:20:41.607] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:20:41.607] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:110:0) after 1m0s
[09:21:41.604] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:110:0)
[09:21:41.604] Timer tick, asking Buildbucket for the build status
[09:21:41.927] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:21:41.927] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:111:0) after 1m0s
[09:22:42.031] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:111:0)
[09:22:42.031] Timer tick, asking Buildbucket for the build status
[09:22:42.183] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:22:42.183] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:112:0) after 1m0s
[09:23:42.301] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:112:0)
[09:23:42.301] Timer tick, asking Buildbucket for the build status
[09:23:42.496] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:23:42.496] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:113:0) after 1m0s
[09:24:42.594] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:113:0)
[09:24:42.594] Timer tick, asking Buildbucket for the build status
[09:24:43.642] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:24:43.642] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:114:0) after 1m0s
[09:25:43.777] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:114:0)
[09:25:43.777] Timer tick, asking Buildbucket for the build status
[09:25:43.891] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:25:43.891] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:115:0) after 1m0s
[09:26:43.966] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:115:0)
[09:26:43.966] Timer tick, asking Buildbucket for the build status
[09:26:44.062] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:26:44.062] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:116:0) after 1m0s
[09:27:44.184] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:116:0)
[09:27:44.184] Timer tick, asking Buildbucket for the build status
[09:27:44.305] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:27:44.305] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:117:0) after 1m0s
[09:28:44.447] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:117:0)
[09:28:44.447] Timer tick, asking Buildbucket for the build status
[09:28:44.534] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:28:44.534] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:118:0) after 1m0s
[09:29:44.648] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:118:0)
[09:29:44.648] Timer tick, asking Buildbucket for the build status
[09:29:45.441] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:29:45.441] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:119:0) after 1m0s
[09:30:45.465] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:119:0)
[09:30:45.465] Timer tick, asking Buildbucket for the build status
[09:30:45.656] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:30:45.656] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:120:0) after 1m0s
[09:31:45.677] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:120:0)
[09:31:45.677] Timer tick, asking Buildbucket for the build status
[09:31:46.079] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:31:46.079] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:121:0) after 1m0s
[09:32:46.105] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:121:0)
[09:32:46.105] Timer tick, asking Buildbucket for the build status
[09:32:46.273] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:32:46.273] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:122:0) after 1m0s
[09:33:46.475] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:122:0)
[09:33:46.475] Timer tick, asking Buildbucket for the build status
[09:33:47.662] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:33:47.662] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:123:0) after 1m0s
[09:34:47.819] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:123:0)
[09:34:47.819] Timer tick, asking Buildbucket for the build status
[09:34:48.234] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:34:48.234] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:124:0) after 1m0s
[09:35:48.269] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:124:0)
[09:35:48.269] Timer tick, asking Buildbucket for the build status
[09:35:48.407] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:35:48.407] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:125:0) after 1m0s
[09:36:48.470] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:125:0)
[09:36:48.470] Timer tick, asking Buildbucket for the build status
[09:36:48.609] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:36:48.609] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:126:0) after 1m0s
[09:37:48.754] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:126:0)
[09:37:48.754] Timer tick, asking Buildbucket for the build status
[09:37:48.851] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:37:48.851] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:127:0) after 1m0s
[09:38:48.890] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:127:0)
[09:38:48.890] Timer tick, asking Buildbucket for the build status
[09:38:49.044] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:38:49.044] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:128:0) after 1m0s
[09:39:49.073] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:128:0)
[09:39:49.073] Timer tick, asking Buildbucket for the build status
[09:39:49.216] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:39:49.216] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:129:0) after 1m0s
[09:40:49.241] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:129:0)
[09:40:49.241] Timer tick, asking Buildbucket for the build status
[09:40:49.399] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:40:49.399] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:130:0) after 1m0s
[09:41:49.439] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:130:0)
[09:41:49.439] Timer tick, asking Buildbucket for the build status
[09:41:49.645] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:41:49.645] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:131:0) after 1m0s
[09:42:49.672] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:131:0)
[09:42:49.672] Timer tick, asking Buildbucket for the build status
[09:42:49.852] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:42:49.852] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:132:0) after 1m0s
[09:43:49.875] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:132:0)
[09:43:49.875] Timer tick, asking Buildbucket for the build status
[09:43:49.997] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:43:49.997] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:133:0) after 1m0s
[09:44:50.021] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:133:0)
[09:44:50.022] Timer tick, asking Buildbucket for the build status
[09:44:50.205] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:44:50.205] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:134:0) after 1m0s
[09:45:50.229] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:134:0)
[09:45:50.229] Timer tick, asking Buildbucket for the build status
[09:45:50.433] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:45:50.433] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:135:0) after 1m0s
[09:46:50.466] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:135:0)
[09:46:50.466] Timer tick, asking Buildbucket for the build status
[09:46:50.791] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:46:50.791] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:136:0) after 1m0s
[09:47:50.951] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:136:0)
[09:47:50.951] Timer tick, asking Buildbucket for the build status
[09:47:51.356] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:47:51.356] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:137:0) after 1m0s
[09:48:51.384] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:137:0)
[09:48:51.384] Timer tick, asking Buildbucket for the build status
[09:48:51.685] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:48:51.685] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:138:0) after 1m0s
[09:49:51.708] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:138:0)
[09:49:51.708] Timer tick, asking Buildbucket for the build status
[09:49:53.012] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:49:53.012] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:139:0) after 1m0s
[09:50:53.097] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:139:0)
[09:50:53.097] Timer tick, asking Buildbucket for the build status
[09:50:53.334] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:50:53.334] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:140:0) after 1m0s
[09:51:53.360] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:140:0)
[09:51:53.360] Timer tick, asking Buildbucket for the build status
[09:51:53.541] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:51:53.541] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:141:0) after 1m0s
[09:52:53.570] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:141:0)
[09:52:53.570] Timer tick, asking Buildbucket for the build status
[09:52:53.740] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:52:53.740] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:142:0) after 1m0s
[09:53:53.763] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:142:0)
[09:53:53.763] Timer tick, asking Buildbucket for the build status
[09:53:53.976] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:53:53.976] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:143:0) after 1m0s
[09:54:54.034] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:143:0)
[09:54:54.034] Timer tick, asking Buildbucket for the build status
[09:54:54.152] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:54:54.152] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:144:0) after 1m0s
[09:55:54.274] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:144:0)
[09:55:54.274] Timer tick, asking Buildbucket for the build status
[09:55:54.389] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:55:54.389] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:145:0) after 1m0s
[09:56:54.565] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:145:0)
[09:56:54.565] Timer tick, asking Buildbucket for the build status
[09:56:54.874] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:56:54.874] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:146:0) after 1m0s
[09:57:54.998] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:146:0)
[09:57:54.998] Timer tick, asking Buildbucket for the build status
[09:57:55.233] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:57:55.233] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:147:0) after 1m0s
[09:58:55.363] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:147:0)
[09:58:55.363] Timer tick, asking Buildbucket for the build status
[09:58:55.510] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:58:55.510] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:148:0) after 1m0s
[09:59:58.286] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:148:0)
[09:59:58.286] Timer tick, asking Buildbucket for the build status
[09:59:58.468] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:59:58.468] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:149:0) after 1m0s
[10:00:58.604] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:149:0)
[10:00:58.604] Timer tick, asking Buildbucket for the build status
[10:00:58.886] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:00:58.886] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:150:0) after 1m0s
[10:01:59.064] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:150:0)
[10:01:59.064] Timer tick, asking Buildbucket for the build status
[10:01:59.149] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:01:59.149] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:151:0) after 1m0s
[10:02:59.263] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:151:0)
[10:02:59.263] Timer tick, asking Buildbucket for the build status
[10:02:59.757] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:02:59.757] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:152:0) after 1m0s
[10:03:59.869] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:152:0)
[10:03:59.869] Timer tick, asking Buildbucket for the build status
[10:04:00.316] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:04:00.316] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:153:0) after 1m0s
[10:05:00.533] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:153:0)
[10:05:00.533] Timer tick, asking Buildbucket for the build status
[10:05:00.757] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:05:00.757] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:154:0) after 1m0s
[10:06:00.828] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:154:0)
[10:06:00.828] Timer tick, asking Buildbucket for the build status
[10:06:01.101] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:06:01.101] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:155:0) after 1m0s
[10:07:01.210] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:155:0)
[10:07:01.210] Timer tick, asking Buildbucket for the build status
[10:07:01.418] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:07:01.418] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:156:0) after 1m0s
[10:08:01.574] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:156:0)
[10:08:01.574] Timer tick, asking Buildbucket for the build status
[10:08:01.887] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:08:01.887] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:157:0) after 1m0s
[10:09:02.098] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:157:0)
[10:09:02.098] Timer tick, asking Buildbucket for the build status
[10:09:02.413] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:09:02.413] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:158:0) after 1m0s
[10:10:02.452] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:158:0)
[10:10:02.452] Timer tick, asking Buildbucket for the build status
[10:10:02.820] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:10:02.820] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:159:0) after 1m0s
[10:11:02.800] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:159:0)
[10:11:02.800] Timer tick, asking Buildbucket for the build status
[10:11:03.088] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:11:03.088] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:160:0) after 1m0s
[10:12:03.209] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:160:0)
[10:12:03.209] Timer tick, asking Buildbucket for the build status
[10:12:03.571] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:12:03.571] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:161:0) after 1m0s
[10:13:03.633] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:161:0)
[10:13:03.633] Timer tick, asking Buildbucket for the build status
[10:13:03.767] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:13:03.767] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:162:0) after 1m0s
[10:14:03.804] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:162:0)
[10:14:03.804] Timer tick, asking Buildbucket for the build status
[10:14:03.934] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:14:03.934] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:163:0) after 1m0s
[10:15:04.042] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:163:0)
[10:15:04.042] Timer tick, asking Buildbucket for the build status
[10:15:04.210] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:15:04.210] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:164:0) after 1m0s
[10:16:04.355] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:164:0)
[10:16:04.355] Timer tick, asking Buildbucket for the build status
[10:16:04.454] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:16:04.454] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:165:0) after 1m0s
[10:17:04.734] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:165:0)
[10:17:04.734] Timer tick, asking Buildbucket for the build status
[10:17:04.901] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:17:04.902] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:166:0) after 1m0s
[10:18:05.072] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:166:0)
[10:18:05.072] Timer tick, asking Buildbucket for the build status
[10:18:05.226] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:18:05.226] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:167:0) after 1m0s
[10:19:05.387] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:167:0)
[10:19:05.387] Timer tick, asking Buildbucket for the build status
[10:19:05.654] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:19:05.654] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:168:0) after 1m0s
[10:20:05.755] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:168:0)
[10:20:05.755] Timer tick, asking Buildbucket for the build status
[10:20:05.895] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:20:05.895] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:169:0) after 1m0s
[10:21:06.021] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:169:0)
[10:21:06.021] Timer tick, asking Buildbucket for the build status
[10:21:06.212] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:21:06.212] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:170:0) after 1m0s
[10:22:06.367] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:170:0)
[10:22:06.367] Timer tick, asking Buildbucket for the build status
[10:22:06.889] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:22:06.889] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:171:0) after 1m0s
[10:23:06.946] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:171:0)
[10:23:06.946] Timer tick, asking Buildbucket for the build status
[10:23:07.118] Build 8885869831859788688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:23:07.118] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9051299893999281056:172:0) after 1m0s
[10:23:24.215] Received PubSub notification, asking Buildbucket for the build status
[10:23:24.452] Build 8885869831859788688: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[10:23:24.452] Buildbucket build:
{
"build": {
"bucket": "luci.infra.cron",
"canary_preference": "PROD",
"completed_ts": "1584181403099578",
"created_by": "project:infra",
"created_ts": "1584171184634415",
"id": "8885869831859788688",
"parameters_json": "{\"builder_name\": \"Build From Tarball\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"buildbucket\": {\"properties\": {\"version\": \"82.0.4085.4\"}, \"tags\": [\"parent_buildername:publish_tarball\", \"user_agent:recipe\"]}, \"id\": \"384a179e-c3ec-4a15-82d8-726f0f8dfd3d\", \"title\": \"publish_tarball/0\"}]}, \"version\": \"82.0.4085.4\"}}",
"project": "infra",
"result": "SUCCESS",
"result_details_json": "{\"properties\": {\"$gatekeeper\": {\"group\": \"chromium.infra.cron\"}, \"$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}, \"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"buildbucket\": {\"properties\": {\"version\": \"82.0.4085.4\"}, \"tags\": [\"parent_buildername:publish_tarball\", \"user_agent:recipe\"]}, \"id\": \"384a179e-c3ec-4a15-82d8-726f0f8dfd3d\", \"title\": \"publish_tarball/0\"}]}, \"bot_id\": \"luci-infra-cron-xenial-large-0-7xcz\", \"buildername\": \"Build From Tarball\", \"path_config\": \"generic\", \"recipe\": \"build_from_tarball\", \"version\": \"82.0.4085.4\"}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"git\", \"vpython\"], \"cores\": [\"32\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"luci-infra-cron-xenial-large-0-7xcz\"], \"image\": [\"chrome-xenial-20030800-300841f894e\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"n1-standard-32\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-16.04\"], \"pool\": [\"luci.infra.cron\"], \"python\": [\"2.7.12\"], \"server_version\": [\"4874-3598771\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-east\", \"us-east1\", \"us-east1-b\"]}}}",
"service_account": "chromium-tarball-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1584171246885482",
"status": "COMPLETED",
"status_changed_ts": "1584181403502080",
"tags": [
"builder:Build From Tarball",
"parent_buildername:publish_tarball",
"scheduler_invocation_id:9051299893999281056",
"scheduler_job_id:infra/Build From Tarball",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/infra/buildbucket/cr-buildbucket.appspot.com/8885869831859788688/+/annotations",
"swarming_tag:luci_project:infra",
"swarming_tag:os:Linux",
"swarming_tag:recipe_name:build_from_tarball",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/infra/infra",
"swarming_task_id:4af0c77c81a77110",
"user_agent:luci-scheduler",
"user_agent:recipe"
],
"updated_ts": "1584181403538239",
"url": "https://ci.chromium.org/b/8885869831859788688",
"utcnow_ts": "1584181404394374"
}
}
[10:23:24.452] Invocation finished in 2h50m21.241628917s with status SUCCEEDED