[21:02:12.291] New invocation is queued and will start shortly
[21:02:13.412] Starting the invocation (attempt 1)
[21:02:13.456] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[21:02:13.456] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[21:02:13.456] Buildbucket request:
{
"bucket": "luci.emscripten-releases.ci",
"client_operation_id": "9042189289976601232",
"parameters_json": "{\"builder_name\":\"mac\",\"properties\":{\"$recipe_engine/scheduler\":{\"hostname\":\"luci-scheduler.appspot.com\",\"triggers\":[{\"gitiles\":{\"ref\":\"refs/heads/master\",\"repo\":\"https://chromium.googlesource.com/emscripten-releases\",\"revision\":\"039a97db6c4a4746dab86dc9a62479cbe2cc2585\"},\"id\":\"https://chromium.googlesource.com/emscripten-releases/+/refs/heads/master@039a97db6c4a4746dab86dc9a62479cbe2cc2585\",\"title\":\"039a97db6c4a4746dab86dc9a62479cbe2cc2585\",\"url\":\"https://chromium.googlesource.com/emscripten-releases/+/039a97db6c4a4746dab86dc9a62479cbe2cc2585\"}]},\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/emscripten-releases\",\"revision\":\"039a97db6c4a4746dab86dc9a62479cbe2cc2585\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:mac",
"scheduler_invocation_id:9042189289976601232",
"scheduler_job_id:emscripten-releases/mac",
"user_agent:luci-scheduler",
"buildset:commit/git/039a97db6c4a4746dab86dc9a62479cbe2cc2585",
"buildset:commit/gitiles/chromium.googlesource.com/emscripten-releases/+/039a97db6c4a4746dab86dc9a62479cbe2cc2585",
"gitiles_ref:refs/heads/master"
]
}
[21:02:15.569] Buildbucket response:
{
"build": {
"bucket": "luci.emscripten-releases.ci",
"canary_preference": "PROD",
"created_by": "project:emscripten-releases",
"created_ts": "1592859733562947",
"id": "8876759227979112848",
"parameters_json": "{\"builder_name\": \"mac\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/emscripten-releases\", \"revision\": \"039a97db6c4a4746dab86dc9a62479cbe2cc2585\"}, \"id\": \"https://chromium.googlesource.com/emscripten-releases/+/refs/heads/master@039a97db6c4a4746dab86dc9a62479cbe2cc2585\", \"title\": \"039a97db6c4a4746dab86dc9a62479cbe2cc2585\", \"url\": \"https://chromium.googlesource.com/emscripten-releases/+/039a97db6c4a4746dab86dc9a62479cbe2cc2585\"}]}, \"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/emscripten-releases\", \"revision\": \"039a97db6c4a4746dab86dc9a62479cbe2cc2585\"}}",
"project": "emscripten-releases",
"result_details_json": "{\"properties\": {}}",
"service_account": "emscripten-releases-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1592859734166057",
"tags": [
"builder:mac",
"buildset:commit/git/039a97db6c4a4746dab86dc9a62479cbe2cc2585",
"buildset:commit/gitiles/chromium.googlesource.com/emscripten-releases/+/039a97db6c4a4746dab86dc9a62479cbe2cc2585",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9042189289976601232",
"scheduler_job_id:emscripten-releases/mac",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/emscripten-releases/buildbucket/cr-buildbucket.appspot.com/8876759227979112848/+/annotations",
"swarming_tag:luci_project:emscripten-releases",
"swarming_tag:recipe_name:emscripten_releases",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:",
"user_agent:luci-scheduler"
],
"updated_ts": "1592859734166226",
"url": "https://ci.chromium.org/b/8876759227979112848",
"utcnow_ts": "1592859735542462"
}
}
[21:02:15.569] Task URL: https://ci.chromium.org/b/8876759227979112848
[21:02:15.569] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:2:0) after 1m0s
[21:02:33.747] Received PubSub notification, asking Buildbucket for the build status
[21:02:33.868] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:03:15.593] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:2:0)
[21:03:15.593] Timer tick, asking Buildbucket for the build status
[21:03:15.929] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:03:15.929] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:4:0) after 1m0s
[21:04:15.947] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:4:0)
[21:04:15.947] Timer tick, asking Buildbucket for the build status
[21:04:16.182] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:04:16.182] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:5:0) after 1m0s
[21:05:16.252] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:5:0)
[21:05:16.252] Timer tick, asking Buildbucket for the build status
[21:05:16.414] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:05:16.414] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:6:0) after 1m0s
[21:06:16.462] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:6:0)
[21:06:16.462] Timer tick, asking Buildbucket for the build status
[21:06:16.654] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:06:16.654] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:7:0) after 1m0s
[21:07:16.685] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:7:0)
[21:07:16.685] Timer tick, asking Buildbucket for the build status
[21:07:16.858] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:07:16.858] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:8:0) after 1m0s
[21:08:16.904] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:8:0)
[21:08:16.904] Timer tick, asking Buildbucket for the build status
[21:08:17.223] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:08:17.223] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:9:0) after 1m0s
[21:09:17.247] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:9:0)
[21:09:17.247] Timer tick, asking Buildbucket for the build status
[21:09:17.358] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:09:17.358] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:10:0) after 1m0s
[21:10:17.414] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:10:0)
[21:10:17.414] Timer tick, asking Buildbucket for the build status
[21:10:17.935] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:10:17.935] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:11:0) after 1m0s
[21:11:17.953] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:11:0)
[21:11:17.953] Timer tick, asking Buildbucket for the build status
[21:11:18.026] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:11:18.026] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:12:0) after 1m0s
[21:12:18.056] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:12:0)
[21:12:18.056] Timer tick, asking Buildbucket for the build status
[21:12:18.187] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:12:18.187] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:13:0) after 1m0s
[21:13:18.174] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:13:0)
[21:13:18.174] Timer tick, asking Buildbucket for the build status
[21:13:18.341] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:13:18.341] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:14:0) after 1m0s
[21:14:18.704] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:14:0)
[21:14:18.705] Timer tick, asking Buildbucket for the build status
[21:14:19.157] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:14:19.157] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:15:0) after 1m0s
[21:15:19.314] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:15:0)
[21:15:19.314] Timer tick, asking Buildbucket for the build status
[21:15:19.423] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:15:19.423] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:16:0) after 1m0s
[21:16:19.479] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:16:0)
[21:16:19.479] Timer tick, asking Buildbucket for the build status
[21:16:19.630] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:16:19.630] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:17:0) after 1m0s
[21:17:19.720] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:17:0)
[21:17:19.720] Timer tick, asking Buildbucket for the build status
[21:17:19.883] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:17:19.883] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:18:0) after 1m0s
[21:18:19.952] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:18:0)
[21:18:19.952] Timer tick, asking Buildbucket for the build status
[21:18:20.343] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:18:20.343] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:19:0) after 1m0s
[21:19:20.372] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:19:0)
[21:19:20.372] Timer tick, asking Buildbucket for the build status
[21:19:21.223] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:19:21.223] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:20:0) after 1m0s
[21:20:21.239] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:20:0)
[21:20:21.239] Timer tick, asking Buildbucket for the build status
[21:20:21.629] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:20:21.629] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:21:0) after 1m0s
[21:21:21.687] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:21:0)
[21:21:21.687] Timer tick, asking Buildbucket for the build status
[21:21:21.950] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:21:21.950] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:22:0) after 1m0s
[21:22:22.067] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:22:0)
[21:22:22.067] Timer tick, asking Buildbucket for the build status
[21:22:22.266] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:22:22.266] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:23:0) after 1m0s
[21:23:22.362] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:23:0)
[21:23:22.362] Timer tick, asking Buildbucket for the build status
[21:23:22.458] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:23:22.458] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:24:0) after 1m0s
[21:24:22.555] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:24:0)
[21:24:22.555] Timer tick, asking Buildbucket for the build status
[21:24:22.860] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:24:22.860] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:25:0) after 1m0s
[21:25:22.896] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:25:0)
[21:25:22.896] Timer tick, asking Buildbucket for the build status
[21:25:23.000] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:25:23.000] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:26:0) after 1m0s
[21:26:23.024] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:26:0)
[21:26:23.024] Timer tick, asking Buildbucket for the build status
[21:26:23.370] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:26:23.370] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:27:0) after 1m0s
[21:27:23.435] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:27:0)
[21:27:23.435] Timer tick, asking Buildbucket for the build status
[21:27:24.655] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:27:24.655] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:28:0) after 1m0s
[21:28:24.712] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:28:0)
[21:28:24.712] Timer tick, asking Buildbucket for the build status
[21:28:24.832] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:28:24.832] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:29:0) after 1m0s
[21:29:24.879] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:29:0)
[21:29:24.879] Timer tick, asking Buildbucket for the build status
[21:29:25.076] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:29:25.076] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:30:0) after 1m0s
[21:30:25.160] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:30:0)
[21:30:25.160] Timer tick, asking Buildbucket for the build status
[21:30:25.328] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:30:25.328] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:31:0) after 1m0s
[21:31:25.365] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:31:0)
[21:31:25.365] Timer tick, asking Buildbucket for the build status
[21:31:25.724] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:31:25.724] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:32:0) after 1m0s
[21:32:25.789] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:32:0)
[21:32:25.789] Timer tick, asking Buildbucket for the build status
[21:32:25.932] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:32:25.932] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:33:0) after 1m0s
[21:33:25.975] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:33:0)
[21:33:25.975] Timer tick, asking Buildbucket for the build status
[21:33:26.068] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:33:26.068] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:34:0) after 1m0s
[21:34:26.128] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:34:0)
[21:34:26.128] Timer tick, asking Buildbucket for the build status
[21:34:26.305] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:34:26.305] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:35:0) after 1m0s
[21:35:26.486] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:35:0)
[21:35:26.486] Timer tick, asking Buildbucket for the build status
[21:35:26.595] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:35:26.595] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:36:0) after 1m0s
[21:36:26.706] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:36:0)
[21:36:26.706] Timer tick, asking Buildbucket for the build status
[21:36:26.853] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:36:26.853] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:37:0) after 1m0s
[21:37:26.946] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:37:0)
[21:37:26.946] Timer tick, asking Buildbucket for the build status
[21:37:27.367] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:37:27.367] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:38:0) after 1m0s
[21:38:27.459] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:38:0)
[21:38:27.459] Timer tick, asking Buildbucket for the build status
[21:38:27.711] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:38:27.711] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:39:0) after 1m0s
[21:39:27.792] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:39:0)
[21:39:27.792] Timer tick, asking Buildbucket for the build status
[21:39:27.886] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:39:27.886] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:40:0) after 1m0s
[21:40:27.975] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:40:0)
[21:40:27.975] Timer tick, asking Buildbucket for the build status
[21:40:28.241] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:40:28.241] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:41:0) after 1m0s
[21:41:28.611] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:41:0)
[21:41:28.611] Timer tick, asking Buildbucket for the build status
[21:41:28.728] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:41:28.728] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:42:0) after 1m0s
[21:42:28.751] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:42:0)
[21:42:28.751] Timer tick, asking Buildbucket for the build status
[21:42:29.103] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:42:29.103] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:43:0) after 1m0s
[21:43:29.221] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:43:0)
[21:43:29.221] Timer tick, asking Buildbucket for the build status
[21:43:29.409] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:43:29.409] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:44:0) after 1m0s
[21:44:29.383] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:44:0)
[21:44:29.383] Timer tick, asking Buildbucket for the build status
[21:44:29.461] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:44:29.461] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:45:0) after 1m0s
[21:45:29.556] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:45:0)
[21:45:29.556] Timer tick, asking Buildbucket for the build status
[21:45:29.847] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:45:29.847] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:46:0) after 1m0s
[21:46:29.927] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:46:0)
[21:46:29.927] Timer tick, asking Buildbucket for the build status
[21:46:30.134] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:46:30.134] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:47:0) after 1m0s
[21:47:30.225] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:47:0)
[21:47:30.225] Timer tick, asking Buildbucket for the build status
[21:47:30.650] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:47:30.650] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:48:0) after 1m0s
[21:48:30.711] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:48:0)
[21:48:30.711] Timer tick, asking Buildbucket for the build status
[21:48:30.871] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:48:30.871] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:49:0) after 1m0s
[21:49:30.997] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:49:0)
[21:49:30.997] Timer tick, asking Buildbucket for the build status
[21:49:34.615] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:49:34.615] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:50:0) after 1m0s
[21:50:34.731] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:50:0)
[21:50:34.731] Timer tick, asking Buildbucket for the build status
[21:50:34.886] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:50:34.886] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:51:0) after 1m0s
[21:51:34.938] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:51:0)
[21:51:34.938] Timer tick, asking Buildbucket for the build status
[21:51:35.058] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:51:35.058] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:52:0) after 1m0s
[21:52:35.121] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:52:0)
[21:52:35.121] Timer tick, asking Buildbucket for the build status
[21:52:35.294] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:52:35.294] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:53:0) after 1m0s
[21:53:35.662] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:53:0)
[21:53:35.662] Timer tick, asking Buildbucket for the build status
[21:53:35.998] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:53:35.998] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:54:0) after 1m0s
[21:54:36.113] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:54:0)
[21:54:36.113] Timer tick, asking Buildbucket for the build status
[21:54:36.265] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:54:36.265] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:55:0) after 1m0s
[21:55:36.371] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:55:0)
[21:55:36.371] Timer tick, asking Buildbucket for the build status
[21:55:36.518] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:55:36.518] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:56:0) after 1m0s
[21:56:36.696] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:56:0)
[21:56:36.696] Timer tick, asking Buildbucket for the build status
[21:56:37.011] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:56:37.011] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:57:0) after 1m0s
[21:57:37.313] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:57:0)
[21:57:37.313] Timer tick, asking Buildbucket for the build status
[21:57:37.372] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:57:37.372] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:58:0) after 1m0s
[21:58:37.518] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:58:0)
[21:58:37.518] Timer tick, asking Buildbucket for the build status
[21:58:38.587] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:58:38.587] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:59:0) after 1m0s
[21:59:38.734] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:59:0)
[21:59:38.734] Timer tick, asking Buildbucket for the build status
[21:59:38.983] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:59:38.983] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:60:0) after 1m0s
[22:00:39.057] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:60:0)
[22:00:39.057] Timer tick, asking Buildbucket for the build status
[22:00:39.418] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:00:39.418] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:61:0) after 1m0s
[22:01:39.458] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:61:0)
[22:01:39.458] Timer tick, asking Buildbucket for the build status
[22:01:39.852] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:01:39.852] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:62:0) after 1m0s
[22:02:39.912] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:62:0)
[22:02:39.912] Timer tick, asking Buildbucket for the build status
[22:02:40.142] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:02:40.142] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:63:0) after 1m0s
[22:03:40.123] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:63:0)
[22:03:40.123] Timer tick, asking Buildbucket for the build status
[22:03:41.333] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:03:41.333] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:64:0) after 1m0s
[22:04:41.369] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:64:0)
[22:04:41.369] Timer tick, asking Buildbucket for the build status
[22:04:41.851] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:04:41.851] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:65:0) after 1m0s
[22:05:41.875] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:65:0)
[22:05:41.875] Timer tick, asking Buildbucket for the build status
[22:05:42.360] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:05:42.360] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:66:0) after 1m0s
[22:06:42.412] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:66:0)
[22:06:42.412] Timer tick, asking Buildbucket for the build status
[22:06:42.876] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:06:42.876] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:67:0) after 1m0s
[22:07:42.847] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:67:0)
[22:07:42.847] Timer tick, asking Buildbucket for the build status
[22:07:42.974] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:07:42.974] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:68:0) after 1m0s
[22:08:43.071] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:68:0)
[22:08:43.071] Timer tick, asking Buildbucket for the build status
[22:08:44.184] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:08:44.184] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:69:0) after 1m0s
[22:09:44.250] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:69:0)
[22:09:44.250] Timer tick, asking Buildbucket for the build status
[22:09:44.318] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:09:44.318] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:70:0) after 1m0s
[22:10:44.353] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:70:0)
[22:10:44.353] Timer tick, asking Buildbucket for the build status
[22:10:44.501] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:10:44.501] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:71:0) after 1m0s
[22:11:44.513] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:71:0)
[22:11:44.513] Timer tick, asking Buildbucket for the build status
[22:11:45.014] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:11:45.014] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:72:0) after 1m0s
[22:12:45.038] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:72:0)
[22:12:45.038] Timer tick, asking Buildbucket for the build status
[22:12:45.192] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:12:45.192] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:73:0) after 1m0s
[22:13:45.254] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:73:0)
[22:13:45.254] Timer tick, asking Buildbucket for the build status
[22:13:48.302] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:13:48.302] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:74:0) after 1m0s
[22:14:48.396] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:74:0)
[22:14:48.396] Timer tick, asking Buildbucket for the build status
[22:14:48.524] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:14:48.524] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:75:0) after 1m0s
[22:15:48.625] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:75:0)
[22:15:48.625] Timer tick, asking Buildbucket for the build status
[22:15:48.760] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:15:48.760] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:76:0) after 1m0s
[22:16:49.050] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:76:0)
[22:16:49.050] Timer tick, asking Buildbucket for the build status
[22:16:49.304] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:16:49.304] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:77:0) after 1m0s
[22:17:49.475] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:77:0)
[22:17:49.475] Timer tick, asking Buildbucket for the build status
[22:17:49.647] Build 8876759227979112848: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:17:49.647] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9042189289976601232:78:0) after 1m0s
[22:18:21.528] Received PubSub notification, asking Buildbucket for the build status
[22:18:21.695] Build 8876759227979112848: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[22:18:21.695] Buildbucket build:
{
"build": {
"bucket": "luci.emscripten-releases.ci",
"canary_preference": "PROD",
"completed_ts": "1592864300654866",
"created_by": "project:emscripten-releases",
"created_ts": "1592859733562947",
"id": "8876759227979112848",
"parameters_json": "{\"builder_name\": \"mac\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/emscripten-releases\", \"revision\": \"039a97db6c4a4746dab86dc9a62479cbe2cc2585\"}, \"id\": \"https://chromium.googlesource.com/emscripten-releases/+/refs/heads/master@039a97db6c4a4746dab86dc9a62479cbe2cc2585\", \"title\": \"039a97db6c4a4746dab86dc9a62479cbe2cc2585\", \"url\": \"https://chromium.googlesource.com/emscripten-releases/+/039a97db6c4a4746dab86dc9a62479cbe2cc2585\"}]}, \"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/emscripten-releases\", \"revision\": \"039a97db6c4a4746dab86dc9a62479cbe2cc2585\"}}",
"project": "emscripten-releases",
"result": "SUCCESS",
"result_details_json": "{\"properties\": {\"$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\": [{\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/emscripten-releases\", \"revision\": \"039a97db6c4a4746dab86dc9a62479cbe2cc2585\"}, \"id\": \"https://chromium.googlesource.com/emscripten-releases/+/refs/heads/master@039a97db6c4a4746dab86dc9a62479cbe2cc2585\", \"title\": \"039a97db6c4a4746dab86dc9a62479cbe2cc2585\", \"url\": \"https://chromium.googlesource.com/emscripten-releases/+/039a97db6c4a4746dab86dc9a62479cbe2cc2585\"}]}, \"bot_id\": \"build498-m9\", \"branch\": \"refs/heads/master\", \"buildername\": \"mac\", \"got_revision\": \"039a97db6c4a4746dab86dc9a62479cbe2cc2585\", \"path_config\": \"generic\", \"recipe\": \"emscripten_releases\", \"repository\": \"https://chromium.googlesource.com/emscripten-releases\", \"revision\": \"039a97db6c4a4746dab86dc9a62479cbe2cc2585\"}, \"swarming\": {\"bot_dimensions\": {\"caches\": [\"builder_0d6fa4fff4995a408e468cf6236551b5d2129f3e939116f3b74cbba851b7eb7d_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"4\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-i7-4578U\"], \"gce\": [\"0\"], \"gpu\": [\"8086\", \"8086:0a2e\"], \"hidpi\": [\"0\"], \"host_class\": [\"default\"], \"id\": [\"build498-m9\"], \"mac_model\": [\"Macmini7,1\"], \"machine_type\": [\"n1-standard-4\"], \"os\": [\"Mac\", \"Mac-10.13\", \"Mac-10.13.6\"], \"pool\": [\"luci.emscripten-releases.ci\"], \"python\": [\"2.7.10\"], \"server_version\": [\"5218-123b763\"], \"ssd\": [\"1\"], \"zone\": [\"us\", \"us-atl\", \"us-atl-golo\", \"us-atl-golo-m9\"]}}}",
"service_account": "emscripten-releases-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1592859752922411",
"status": "COMPLETED",
"status_changed_ts": "1592864301123499",
"tags": [
"builder:mac",
"buildset:commit/git/039a97db6c4a4746dab86dc9a62479cbe2cc2585",
"buildset:commit/gitiles/chromium.googlesource.com/emscripten-releases/+/039a97db6c4a4746dab86dc9a62479cbe2cc2585",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9042189289976601232",
"scheduler_job_id:emscripten-releases/mac",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/emscripten-releases/buildbucket/cr-buildbucket.appspot.com/8876759227979112848/+/annotations",
"swarming_tag:luci_project:emscripten-releases",
"swarming_tag:os:Mac",
"swarming_tag:recipe_name:emscripten_releases",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:4cf6a84a074c7510",
"user_agent:luci-scheduler"
],
"updated_ts": "1592864301156954",
"url": "https://ci.chromium.org/b/8876759227979112848",
"utcnow_ts": "1592864301686039"
}
}
[22:18:21.695] Invocation finished in 1h16m9.422546044s with status SUCCEEDED