[22:23:46.866] New invocation is queued and will start shortly
[22:23:47.898] Starting the invocation (attempt 1)
[22:23:47.928] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[22:23:47.928] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[22:23:47.928] Buildbucket request:
{
"bucket": "luci.emscripten-releases.ci",
"client_operation_id": "9018175961545104160",
"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\":\"c7f4c2a04a07043c55d110ae2bc89b675fce4499\"},\"id\":\"https://chromium.googlesource.com/emscripten-releases/+/refs/heads/master@c7f4c2a04a07043c55d110ae2bc89b675fce4499\",\"title\":\"c7f4c2a04a07043c55d110ae2bc89b675fce4499\",\"url\":\"https://chromium.googlesource.com/emscripten-releases/+/c7f4c2a04a07043c55d110ae2bc89b675fce4499\"}]},\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/emscripten-releases\",\"revision\":\"c7f4c2a04a07043c55d110ae2bc89b675fce4499\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:mac",
"scheduler_invocation_id:9018175961545104160",
"scheduler_job_id:emscripten-releases/mac",
"user_agent:luci-scheduler",
"buildset:commit/git/c7f4c2a04a07043c55d110ae2bc89b675fce4499",
"buildset:commit/gitiles/chromium.googlesource.com/emscripten-releases/+/c7f4c2a04a07043c55d110ae2bc89b675fce4499",
"gitiles_ref:refs/heads/master"
]
}
[22:23:48.472] Buildbucket response:
{
"build": {
"bucket": "luci.emscripten-releases.ci",
"canary_preference": "PROD",
"created_by": "project:emscripten-releases",
"created_ts": "1615760628031990",
"id": "8852745899660213424",
"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\": \"c7f4c2a04a07043c55d110ae2bc89b675fce4499\"}, \"id\": \"https://chromium.googlesource.com/emscripten-releases/+/refs/heads/master@c7f4c2a04a07043c55d110ae2bc89b675fce4499\", \"title\": \"c7f4c2a04a07043c55d110ae2bc89b675fce4499\", \"url\": \"https://chromium.googlesource.com/emscripten-releases/+/c7f4c2a04a07043c55d110ae2bc89b675fce4499\"}]}, \"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/emscripten-releases\", \"revision\": \"c7f4c2a04a07043c55d110ae2bc89b675fce4499\"}}",
"project": "emscripten-releases",
"result_details_json": "{\"properties\": {}}",
"service_account": "emscripten-releases-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1615760628326676",
"tags": [
"builder:mac",
"buildset:commit/git/c7f4c2a04a07043c55d110ae2bc89b675fce4499",
"buildset:commit/gitiles/chromium.googlesource.com/emscripten-releases/+/c7f4c2a04a07043c55d110ae2bc89b675fce4499",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9018175961545104160",
"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/8852745899660213424/+/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": "1615760628326823",
"url": "https://ci.chromium.org/b/8852745899660213424",
"utcnow_ts": "1615760628465751"
}
}
[22:23:48.472] Task URL: https://ci.chromium.org/b/8852745899660213424
[22:23:48.472] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:2:0) after 1m0s
[22:24:12.799] Received PubSub notification, asking Buildbucket for the build status
[22:24:12.915] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:24:48.512] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:2:0)
[22:24:48.512] Timer tick, asking Buildbucket for the build status
[22:24:48.581] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:24:48.581] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:4:0) after 1m0s
[22:25:48.653] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:4:0)
[22:25:48.653] Timer tick, asking Buildbucket for the build status
[22:25:48.897] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:25:48.897] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:5:0) after 1m0s
[22:26:48.907] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:5:0)
[22:26:48.907] Timer tick, asking Buildbucket for the build status
[22:26:49.003] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:26:49.003] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:6:0) after 1m0s
[22:27:49.075] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:6:0)
[22:27:49.076] Timer tick, asking Buildbucket for the build status
[22:27:49.349] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:27:49.349] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:7:0) after 1m0s
[22:28:49.364] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:7:0)
[22:28:49.364] Timer tick, asking Buildbucket for the build status
[22:28:49.428] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:28:49.428] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:8:0) after 1m0s
[22:29:49.446] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:8:0)
[22:29:49.446] Timer tick, asking Buildbucket for the build status
[22:29:49.899] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:29:49.899] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:9:0) after 1m0s
[22:30:49.952] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:9:0)
[22:30:49.952] Timer tick, asking Buildbucket for the build status
[22:30:50.054] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:30:50.054] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:10:0) after 1m0s
[22:31:50.071] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:10:0)
[22:31:50.071] Timer tick, asking Buildbucket for the build status
[22:31:50.149] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:31:50.149] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:11:0) after 1m0s
[22:32:50.165] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:11:0)
[22:32:50.165] Timer tick, asking Buildbucket for the build status
[22:32:50.297] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:32:50.297] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:12:0) after 1m0s
[22:33:50.324] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:12:0)
[22:33:50.324] Timer tick, asking Buildbucket for the build status
[22:33:50.415] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:33:50.415] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:13:0) after 1m0s
[22:34:50.502] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:13:0)
[22:34:50.502] Timer tick, asking Buildbucket for the build status
[22:34:50.573] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:34:50.573] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:14:0) after 1m0s
[22:35:50.589] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:14:0)
[22:35:50.589] Timer tick, asking Buildbucket for the build status
[22:35:50.669] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:35:50.669] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:15:0) after 1m0s
[22:36:50.683] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:15:0)
[22:36:50.683] Timer tick, asking Buildbucket for the build status
[22:36:50.852] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:36:50.852] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:16:0) after 1m0s
[22:37:50.869] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:16:0)
[22:37:50.869] Timer tick, asking Buildbucket for the build status
[22:37:50.967] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:37:50.967] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:17:0) after 1m0s
[22:38:51.016] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:17:0)
[22:38:51.017] Timer tick, asking Buildbucket for the build status
[22:38:51.309] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:38:51.309] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:18:0) after 1m0s
[22:39:51.319] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:18:0)
[22:39:51.319] Timer tick, asking Buildbucket for the build status
[22:39:51.465] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:39:51.466] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:19:0) after 1m0s
[22:40:51.495] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:19:0)
[22:40:51.495] Timer tick, asking Buildbucket for the build status
[22:40:51.772] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:40:51.772] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:20:0) after 1m0s
[22:41:51.790] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:20:0)
[22:41:51.790] Timer tick, asking Buildbucket for the build status
[22:41:52.050] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:41:52.050] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:21:0) after 1m0s
[22:42:52.077] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:21:0)
[22:42:52.077] Timer tick, asking Buildbucket for the build status
[22:42:52.142] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:42:52.142] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:22:0) after 1m0s
[22:43:52.164] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:22:0)
[22:43:52.164] Timer tick, asking Buildbucket for the build status
[22:43:52.393] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:43:52.393] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:23:0) after 1m0s
[22:44:52.409] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:23:0)
[22:44:52.409] Timer tick, asking Buildbucket for the build status
[22:44:52.588] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:44:52.588] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:24:0) after 1m0s
[22:45:52.621] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:24:0)
[22:45:52.621] Timer tick, asking Buildbucket for the build status
[22:45:52.801] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:45:52.801] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:25:0) after 1m0s
[22:46:52.781] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:25:0)
[22:46:52.781] Timer tick, asking Buildbucket for the build status
[22:46:52.845] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:46:52.845] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:26:0) after 1m0s
[22:47:52.868] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:26:0)
[22:47:52.868] Timer tick, asking Buildbucket for the build status
[22:47:52.936] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:47:52.936] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:27:0) after 1m0s
[22:48:52.976] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:27:0)
[22:48:52.976] Timer tick, asking Buildbucket for the build status
[22:48:53.154] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:48:53.154] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:28:0) after 1m0s
[22:49:53.194] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:28:0)
[22:49:53.194] Timer tick, asking Buildbucket for the build status
[22:49:53.268] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:49:53.268] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:29:0) after 1m0s
[22:50:53.481] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:29:0)
[22:50:53.482] Timer tick, asking Buildbucket for the build status
[22:50:53.556] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:50:53.556] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:30:0) after 1m0s
[22:51:53.574] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:30:0)
[22:51:53.574] Timer tick, asking Buildbucket for the build status
[22:51:53.639] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:51:53.639] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:31:0) after 1m0s
[22:52:53.666] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:31:0)
[22:52:53.666] Timer tick, asking Buildbucket for the build status
[22:52:53.942] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:52:53.943] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:32:0) after 1m0s
[22:53:54.167] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:32:0)
[22:53:54.167] Timer tick, asking Buildbucket for the build status
[22:53:54.246] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:53:54.246] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:33:0) after 1m0s
[22:54:54.315] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:33:0)
[22:54:54.315] Timer tick, asking Buildbucket for the build status
[22:54:54.414] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:54:54.414] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:34:0) after 1m0s
[22:55:54.436] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:34:0)
[22:55:54.436] Timer tick, asking Buildbucket for the build status
[22:55:54.509] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:55:54.509] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:35:0) after 1m0s
[22:56:54.633] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:35:0)
[22:56:54.633] Timer tick, asking Buildbucket for the build status
[22:56:54.939] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:56:54.939] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:36:0) after 1m0s
[22:57:55.006] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:36:0)
[22:57:55.006] Timer tick, asking Buildbucket for the build status
[22:57:55.069] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:57:55.069] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:37:0) after 1m0s
[22:58:55.049] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:37:0)
[22:58:55.049] Timer tick, asking Buildbucket for the build status
[22:58:56.846] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:58:56.846] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:38:0) after 1m0s
[22:59:56.866] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:38:0)
[22:59:56.866] Timer tick, asking Buildbucket for the build status
[22:59:56.955] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:59:56.955] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:39:0) after 1m0s
[23:00:56.970] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:39:0)
[23:00:56.970] Timer tick, asking Buildbucket for the build status
[23:00:57.312] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:00:57.312] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:40:0) after 1m0s
[23:01:57.331] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:40:0)
[23:01:57.331] Timer tick, asking Buildbucket for the build status
[23:01:57.535] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:01:57.535] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:41:0) after 1m0s
[23:02:58.884] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:41:0)
[23:02:58.884] Timer tick, asking Buildbucket for the build status
[23:02:58.960] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:02:58.960] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:42:0) after 1m0s
[23:03:59.810] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:42:0)
[23:03:59.810] Timer tick, asking Buildbucket for the build status
[23:03:59.906] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:03:59.906] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:43:0) after 1m0s
[23:04:59.920] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:43:0)
[23:04:59.920] Timer tick, asking Buildbucket for the build status
[23:04:59.990] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:04:59.990] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:44:0) after 1m0s
[23:06:00.011] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:44:0)
[23:06:00.011] Timer tick, asking Buildbucket for the build status
[23:06:00.353] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:06:00.353] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:45:0) after 1m0s
[23:07:00.418] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:45:0)
[23:07:00.418] Timer tick, asking Buildbucket for the build status
[23:07:00.492] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:07:00.492] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:46:0) after 1m0s
[23:08:00.556] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:46:0)
[23:08:00.556] Timer tick, asking Buildbucket for the build status
[23:08:00.627] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:08:00.627] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:47:0) after 1m0s
[23:09:00.790] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:47:0)
[23:09:00.790] Timer tick, asking Buildbucket for the build status
[23:09:01.194] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:09:01.194] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:48:0) after 1m0s
[23:10:01.422] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:48:0)
[23:10:01.422] Timer tick, asking Buildbucket for the build status
[23:10:01.503] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:10:01.503] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:49:0) after 1m0s
[23:11:01.524] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:49:0)
[23:11:01.524] Timer tick, asking Buildbucket for the build status
[23:11:01.689] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:11:01.689] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:50:0) after 1m0s
[23:12:01.697] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:50:0)
[23:12:01.697] Timer tick, asking Buildbucket for the build status
[23:12:01.972] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:12:01.972] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:51:0) after 1m0s
[23:13:02.015] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:51:0)
[23:13:02.015] Timer tick, asking Buildbucket for the build status
[23:13:02.304] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:13:02.304] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:52:0) after 1m0s
[23:14:02.375] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:52:0)
[23:14:02.375] Timer tick, asking Buildbucket for the build status
[23:14:02.503] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:14:02.503] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:53:0) after 1m0s
[23:15:02.618] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:53:0)
[23:15:02.618] Timer tick, asking Buildbucket for the build status
[23:15:02.869] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:15:02.869] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:54:0) after 1m0s
[23:16:02.894] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:54:0)
[23:16:02.894] Timer tick, asking Buildbucket for the build status
[23:16:03.257] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:16:03.257] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:55:0) after 1m0s
[23:17:03.281] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:55:0)
[23:17:03.281] Timer tick, asking Buildbucket for the build status
[23:17:03.391] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:17:03.391] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:56:0) after 1m0s
[23:18:03.448] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:56:0)
[23:18:03.448] Timer tick, asking Buildbucket for the build status
[23:18:03.659] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:18:03.659] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:57:0) after 1m0s
[23:19:03.718] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:57:0)
[23:19:03.718] Timer tick, asking Buildbucket for the build status
[23:19:03.995] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:19:03.995] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:58:0) after 1m0s
[23:20:04.023] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:58:0)
[23:20:04.023] Timer tick, asking Buildbucket for the build status
[23:20:04.437] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:20:04.437] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:59:0) after 1m0s
[23:21:04.493] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:59:0)
[23:21:04.493] Timer tick, asking Buildbucket for the build status
[23:21:04.761] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:21:04.761] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:60:0) after 1m0s
[23:22:04.780] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:60:0)
[23:22:04.780] Timer tick, asking Buildbucket for the build status
[23:22:04.870] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:22:04.870] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:61:0) after 1m0s
[23:23:04.875] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:61:0)
[23:23:04.875] Timer tick, asking Buildbucket for the build status
[23:23:04.989] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:23:04.989] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:62:0) after 1m0s
[23:24:05.046] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:62:0)
[23:24:05.046] Timer tick, asking Buildbucket for the build status
[23:24:05.136] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:24:05.136] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:63:0) after 1m0s
[23:25:05.242] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:63:0)
[23:25:05.242] Timer tick, asking Buildbucket for the build status
[23:25:05.345] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:25:05.345] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:64:0) after 1m0s
[23:26:05.459] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:64:0)
[23:26:05.459] Timer tick, asking Buildbucket for the build status
[23:26:05.646] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:26:05.646] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:65:0) after 1m0s
[23:27:05.708] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:65:0)
[23:27:05.708] Timer tick, asking Buildbucket for the build status
[23:27:06.748] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:27:06.748] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:66:0) after 1m0s
[23:28:06.857] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:66:0)
[23:28:06.857] Timer tick, asking Buildbucket for the build status
[23:28:06.938] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:28:06.938] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:67:0) after 1m0s
[23:29:07.004] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:67:0)
[23:29:07.004] Timer tick, asking Buildbucket for the build status
[23:29:07.617] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:29:07.617] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:68:0) after 1m0s
[23:30:07.694] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:68:0)
[23:30:07.694] Timer tick, asking Buildbucket for the build status
[23:30:07.789] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:30:07.789] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:69:0) after 1m0s
[23:31:07.848] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:69:0)
[23:31:07.848] Timer tick, asking Buildbucket for the build status
[23:31:07.940] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:31:07.940] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:70:0) after 1m0s
[23:32:08.120] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:70:0)
[23:32:08.120] Timer tick, asking Buildbucket for the build status
[23:32:08.191] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:32:08.191] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:71:0) after 1m0s
[23:33:08.239] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:71:0)
[23:33:08.239] Timer tick, asking Buildbucket for the build status
[23:33:08.356] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:33:08.356] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:72:0) after 1m0s
[23:34:08.465] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:72:0)
[23:34:08.465] Timer tick, asking Buildbucket for the build status
[23:34:08.557] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:34:08.557] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:73:0) after 1m0s
[23:35:08.602] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:73:0)
[23:35:08.602] Timer tick, asking Buildbucket for the build status
[23:35:08.670] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:35:08.670] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:74:0) after 1m0s
[23:36:08.700] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:74:0)
[23:36:08.700] Timer tick, asking Buildbucket for the build status
[23:36:08.771] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:36:08.771] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:75:0) after 1m0s
[23:37:08.844] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:75:0)
[23:37:08.844] Timer tick, asking Buildbucket for the build status
[23:37:08.938] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:37:08.938] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:76:0) after 1m0s
[23:38:08.975] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:76:0)
[23:38:08.975] Timer tick, asking Buildbucket for the build status
[23:38:09.058] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:38:09.058] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:77:0) after 1m0s
[23:39:09.123] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:77:0)
[23:39:09.123] Timer tick, asking Buildbucket for the build status
[23:39:09.200] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:39:09.200] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:78:0) after 1m0s
[23:40:09.206] Handling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:78:0)
[23:40:09.206] Timer tick, asking Buildbucket for the build status
[23:40:09.308] Build 8852745899660213424: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:40:09.308] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/mac:9018175961545104160:79:0) after 1m0s
[23:40:54.569] Received PubSub notification, asking Buildbucket for the build status
[23:40:54.749] Build 8852745899660213424: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[23:40:54.749] Buildbucket build:
{
"build": {
"bucket": "luci.emscripten-releases.ci",
"canary_preference": "PROD",
"completed_ts": "1615765253923418",
"created_by": "project:emscripten-releases",
"created_ts": "1615760628031990",
"id": "8852745899660213424",
"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\": \"c7f4c2a04a07043c55d110ae2bc89b675fce4499\"}, \"id\": \"https://chromium.googlesource.com/emscripten-releases/+/refs/heads/master@c7f4c2a04a07043c55d110ae2bc89b675fce4499\", \"title\": \"c7f4c2a04a07043c55d110ae2bc89b675fce4499\", \"url\": \"https://chromium.googlesource.com/emscripten-releases/+/c7f4c2a04a07043c55d110ae2bc89b675fce4499\"}]}, \"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/emscripten-releases\", \"revision\": \"c7f4c2a04a07043c55d110ae2bc89b675fce4499\"}}",
"project": "emscripten-releases",
"result": "SUCCESS",
"result_details_json": "{\"properties\": {\"$build/goma\": {\"rpc_extra_params\": \"?prod\", \"server_host\": \"goma.chromium.org\", \"use_luci_auth\": true}, \"$recipe_engine/path\": {\"cache_dir\": \"/opt/s/w/ir/cache\", \"temp_dir\": \"/opt/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\": \"c7f4c2a04a07043c55d110ae2bc89b675fce4499\"}, \"id\": \"https://chromium.googlesource.com/emscripten-releases/+/refs/heads/master@c7f4c2a04a07043c55d110ae2bc89b675fce4499\", \"title\": \"c7f4c2a04a07043c55d110ae2bc89b675fce4499\", \"url\": \"https://chromium.googlesource.com/emscripten-releases/+/c7f4c2a04a07043c55d110ae2bc89b675fce4499\"}]}, \"bot_id\": \"build498-m9\", \"branch\": \"refs/heads/master\", \"buildername\": \"mac\", \"got_revision\": \"c7f4c2a04a07043c55d110ae2bc89b675fce4499\", \"path_config\": \"generic\", \"recipe\": \"emscripten_releases\", \"repository\": \"https://chromium.googlesource.com/emscripten-releases\", \"revision\": \"c7f4c2a04a07043c55d110ae2bc89b675fce4499\"}, \"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\", \"Mac-10.15\", \"Mac-10.15.6\", \"Mac-10.15.6-19G2021\"], \"pool\": [\"luci.emscripten-releases.ci\"], \"python\": [\"2.7.16\"], \"server_version\": [\"5754-8c4f760\"], \"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": "1615760649956895",
"status": "COMPLETED",
"status_changed_ts": "1615765254217115",
"tags": [
"builder:mac",
"buildset:commit/git/c7f4c2a04a07043c55d110ae2bc89b675fce4499",
"buildset:commit/gitiles/chromium.googlesource.com/emscripten-releases/+/c7f4c2a04a07043c55d110ae2bc89b675fce4499",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9018175961545104160",
"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/8852745899660213424/+/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:524ba82470f99510",
"user_agent:luci-scheduler"
],
"updated_ts": "1615765254259738",
"url": "https://ci.chromium.org/b/8852745899660213424",
"utcnow_ts": "1615765254725516"
}
}
[23:40:54.750] Invocation finished in 1h17m7.899771575s with status SUCCEEDED