buildbucket: <
  server: "cr-buildbucket.appspot.com"
  bucket: "luci.emscripten-releases.ci"
  builder: "win"
>

• f90c69a608ae8b0dba78b612dd09fcc8e4992a36 (5 years ago)

{
  "branch": "refs/heads/master",
  "repository": "https://chromium.googlesource.com/emscripten-releases",
  "revision": "f90c69a608ae8b0dba78b612dd09fcc8e4992a36"
}

• buildset:commit/git/f90c69a608ae8b0dba78b612dd09fcc8e4992a36
• buildset:commit/gitiles/chromium.googlesource.com/emscripten-releases/+/f90c69a608ae8b0dba78b612dd09fcc8e4992a36
• gitiles_ref:refs/heads/master

[11:57:59.588] New invocation is queued and will start shortly
[11:58:01.484] Starting the invocation (attempt 1)
[11:58:01.515] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[11:58:01.515] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[11:58:01.515] Buildbucket request:
{
  "bucket": "luci.emscripten-releases.ci",
  "client_operation_id": "9019483690251606384",
  "parameters_json": "{\"builder_name\":\"win\",\"properties\":{\"$recipe_engine/scheduler\":{\"hostname\":\"luci-scheduler.appspot.com\",\"triggers\":[{\"gitiles\":{\"ref\":\"refs/heads/master\",\"repo\":\"https://chromium.googlesource.com/emscripten-releases\",\"revision\":\"f90c69a608ae8b0dba78b612dd09fcc8e4992a36\"},\"id\":\"https://chromium.googlesource.com/emscripten-releases/+/refs/heads/master@f90c69a608ae8b0dba78b612dd09fcc8e4992a36\",\"title\":\"f90c69a608ae8b0dba78b612dd09fcc8e4992a36\",\"url\":\"https://chromium.googlesource.com/emscripten-releases/+/f90c69a608ae8b0dba78b612dd09fcc8e4992a36\"}]},\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/emscripten-releases\",\"revision\":\"f90c69a608ae8b0dba78b612dd09fcc8e4992a36\"}}",
  "pubsub_callback": {
    "auth_token": "...",
    "topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
  },
  "tags": [
    "builder:win",
    "scheduler_invocation_id:9019483690251606384",
    "scheduler_job_id:emscripten-releases/win",
    "user_agent:luci-scheduler",
    "buildset:commit/git/f90c69a608ae8b0dba78b612dd09fcc8e4992a36",
    "buildset:commit/gitiles/chromium.googlesource.com/emscripten-releases/+/f90c69a608ae8b0dba78b612dd09fcc8e4992a36",
    "gitiles_ref:refs/heads/master"
  ]
}
[11:58:01.933] Buildbucket response:
{
  "build": {
    "bucket": "luci.emscripten-releases.ci",
    "canary_preference": "PROD",
    "created_by": "project:emscripten-releases",
    "created_ts": "1614513481597274",
    "id": "8854053627478985856",
    "parameters_json": "{\"builder_name\": \"win\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/emscripten-releases\", \"revision\": \"f90c69a608ae8b0dba78b612dd09fcc8e4992a36\"}, \"id\": \"https://chromium.googlesource.com/emscripten-releases/+/refs/heads/master@f90c69a608ae8b0dba78b612dd09fcc8e4992a36\", \"title\": \"f90c69a608ae8b0dba78b612dd09fcc8e4992a36\", \"url\": \"https://chromium.googlesource.com/emscripten-releases/+/f90c69a608ae8b0dba78b612dd09fcc8e4992a36\"}]}, \"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/emscripten-releases\", \"revision\": \"f90c69a608ae8b0dba78b612dd09fcc8e4992a36\"}}",
    "project": "emscripten-releases",
    "result_details_json": "{\"properties\": {}}",
    "service_account": "emscripten-releases-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
    "status": "SCHEDULED",
    "status_changed_ts": "1614513481816550",
    "tags": [
      "builder:win",
      "buildset:commit/git/f90c69a608ae8b0dba78b612dd09fcc8e4992a36",
      "buildset:commit/gitiles/chromium.googlesource.com/emscripten-releases/+/f90c69a608ae8b0dba78b612dd09fcc8e4992a36",
      "gitiles_ref:refs/heads/master",
      "scheduler_invocation_id:9019483690251606384",
      "scheduler_job_id:emscripten-releases/win",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/emscripten-releases/buildbucket/cr-buildbucket.appspot.com/8854053627478985856/+/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": "1614513481816660",
    "url": "https://ci.chromium.org/b/8854053627478985856",
    "utcnow_ts": "1614513481927110"
  }
}
[11:58:01.933] Task URL: https://ci.chromium.org/b/8854053627478985856
[11:58:01.933] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:2:0) after 1m0s
[11:58:36.845] Received PubSub notification, asking Buildbucket for the build status
[11:58:37.247] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:59:02.240] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:2:0)
[11:59:02.240] Timer tick, asking Buildbucket for the build status
[11:59:02.568] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:59:02.568] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:4:0) after 1m0s
[12:00:02.592] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:4:0)
[12:00:02.592] Timer tick, asking Buildbucket for the build status
[12:00:02.884] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:00:02.884] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:5:0) after 1m0s
[12:01:02.902] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:5:0)
[12:01:02.902] Timer tick, asking Buildbucket for the build status
[12:01:03.073] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:01:03.073] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:6:0) after 1m0s
[12:02:03.232] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:6:0)
[12:02:03.232] Timer tick, asking Buildbucket for the build status
[12:02:03.419] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:02:03.419] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:7:0) after 1m0s
[12:03:03.438] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:7:0)
[12:03:03.438] Timer tick, asking Buildbucket for the build status
[12:03:03.534] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:03:03.534] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:8:0) after 1m0s
[12:04:03.558] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:8:0)
[12:04:03.558] Timer tick, asking Buildbucket for the build status
[12:04:03.718] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:04:03.718] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:9:0) after 1m0s
[12:05:03.741] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:9:0)
[12:05:03.741] Timer tick, asking Buildbucket for the build status
[12:05:03.826] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:05:03.826] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:10:0) after 1m0s
[12:06:03.814] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:10:0)
[12:06:03.814] Timer tick, asking Buildbucket for the build status
[12:06:04.063] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:06:04.063] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:11:0) after 1m0s
[12:07:04.313] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:11:0)
[12:07:04.313] Timer tick, asking Buildbucket for the build status
[12:07:04.523] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:07:04.523] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:12:0) after 1m0s
[12:08:04.859] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:12:0)
[12:08:04.859] Timer tick, asking Buildbucket for the build status
[12:08:04.949] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:08:04.949] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:13:0) after 1m0s
[12:09:04.964] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:13:0)
[12:09:04.964] Timer tick, asking Buildbucket for the build status
[12:09:05.186] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:09:05.186] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:14:0) after 1m0s
[12:10:05.439] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:14:0)
[12:10:05.439] Timer tick, asking Buildbucket for the build status
[12:10:05.519] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:10:05.519] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:15:0) after 1m0s
[12:11:08.269] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:15:0)
[12:11:08.269] Timer tick, asking Buildbucket for the build status
[12:11:08.331] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:11:08.331] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:16:0) after 1m0s
[12:12:08.861] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:16:0)
[12:12:08.861] Timer tick, asking Buildbucket for the build status
[12:12:09.038] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:12:09.038] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:17:0) after 1m0s
[12:13:09.276] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:17:0)
[12:13:09.276] Timer tick, asking Buildbucket for the build status
[12:13:09.385] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:13:09.385] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:18:0) after 1m0s
[12:14:09.403] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:18:0)
[12:14:09.403] Timer tick, asking Buildbucket for the build status
[12:14:09.485] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:14:09.485] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:19:0) after 1m0s
[12:15:09.500] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:19:0)
[12:15:09.500] Timer tick, asking Buildbucket for the build status
[12:15:10.032] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:15:10.032] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:20:0) after 1m0s
[12:16:10.048] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:20:0)
[12:16:10.048] Timer tick, asking Buildbucket for the build status
[12:16:10.125] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:16:10.125] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:21:0) after 1m0s
[12:17:10.142] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:21:0)
[12:17:10.142] Timer tick, asking Buildbucket for the build status
[12:17:10.261] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:17:10.261] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:22:0) after 1m0s
[12:18:10.300] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:22:0)
[12:18:10.300] Timer tick, asking Buildbucket for the build status
[12:18:10.513] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:18:10.513] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:23:0) after 1m0s
[12:19:10.539] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:23:0)
[12:19:10.539] Timer tick, asking Buildbucket for the build status
[12:19:10.609] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:19:10.609] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:24:0) after 1m0s
[12:20:10.693] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:24:0)
[12:20:10.693] Timer tick, asking Buildbucket for the build status
[12:20:10.821] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:20:10.821] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:25:0) after 1m0s
[12:21:10.838] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:25:0)
[12:21:10.838] Timer tick, asking Buildbucket for the build status
[12:21:11.111] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:21:11.111] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:26:0) after 1m0s
[12:22:11.147] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:26:0)
[12:22:11.147] Timer tick, asking Buildbucket for the build status
[12:22:11.263] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:22:11.263] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:27:0) after 1m0s
[12:23:11.429] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:27:0)
[12:23:11.429] Timer tick, asking Buildbucket for the build status
[12:23:11.564] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:23:11.564] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:28:0) after 1m0s
[12:24:11.674] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:28:0)
[12:24:11.674] Timer tick, asking Buildbucket for the build status
[12:24:11.767] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:24:11.767] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:29:0) after 1m0s
[12:25:11.814] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:29:0)
[12:25:11.814] Timer tick, asking Buildbucket for the build status
[12:25:11.962] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:25:11.962] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:30:0) after 1m0s
[12:26:12.114] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:30:0)
[12:26:12.114] Timer tick, asking Buildbucket for the build status
[12:26:12.268] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:26:12.268] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:31:0) after 1m0s
[12:27:12.284] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:31:0)
[12:27:12.284] Timer tick, asking Buildbucket for the build status
[12:27:12.443] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:27:12.443] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:32:0) after 1m0s
[12:28:12.567] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:32:0)
[12:28:12.567] Timer tick, asking Buildbucket for the build status
[12:28:12.798] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:28:12.798] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:33:0) after 1m0s
[12:29:12.815] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:33:0)
[12:29:12.815] Timer tick, asking Buildbucket for the build status
[12:29:12.982] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:29:12.982] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:34:0) after 1m0s
[12:30:13.017] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:34:0)
[12:30:13.017] Timer tick, asking Buildbucket for the build status
[12:30:14.061] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:30:14.061] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:35:0) after 1m0s
[12:31:14.078] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:35:0)
[12:31:14.078] Timer tick, asking Buildbucket for the build status
[12:31:14.398] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:31:14.398] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:36:0) after 1m0s
[12:32:14.458] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:36:0)
[12:32:14.459] Timer tick, asking Buildbucket for the build status
[12:32:14.547] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:32:14.547] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:37:0) after 1m0s
[12:33:14.580] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:37:0)
[12:33:14.580] Timer tick, asking Buildbucket for the build status
[12:33:14.654] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:33:14.654] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:38:0) after 1m0s
[12:34:14.679] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:38:0)
[12:34:14.679] Timer tick, asking Buildbucket for the build status
[12:34:14.764] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:34:14.764] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:39:0) after 1m0s
[12:35:14.781] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:39:0)
[12:35:14.781] Timer tick, asking Buildbucket for the build status
[12:35:14.861] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:35:14.861] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:40:0) after 1m0s
[12:36:14.878] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:40:0)
[12:36:14.878] Timer tick, asking Buildbucket for the build status
[12:36:14.977] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:36:14.977] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:41:0) after 1m0s
[12:37:14.994] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:41:0)
[12:37:14.994] Timer tick, asking Buildbucket for the build status
[12:37:15.117] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:37:15.117] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:42:0) after 1m0s
[12:38:15.177] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:42:0)
[12:38:15.177] Timer tick, asking Buildbucket for the build status
[12:38:15.637] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:38:15.637] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:43:0) after 1m0s
[12:39:15.653] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:43:0)
[12:39:15.653] Timer tick, asking Buildbucket for the build status
[12:39:15.967] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:39:15.967] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:44:0) after 1m0s
[12:40:15.988] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:44:0)
[12:40:15.988] Timer tick, asking Buildbucket for the build status
[12:40:16.154] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:40:16.154] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:45:0) after 1m0s
[12:41:16.185] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:45:0)
[12:41:16.185] Timer tick, asking Buildbucket for the build status
[12:41:16.250] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:41:16.250] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:46:0) after 1m0s
[12:42:16.384] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:46:0)
[12:42:16.384] Timer tick, asking Buildbucket for the build status
[12:42:16.604] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:42:16.604] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:47:0) after 1m0s
[12:43:16.719] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:47:0)
[12:43:16.719] Timer tick, asking Buildbucket for the build status
[12:43:16.974] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:43:16.974] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:48:0) after 1m0s
[12:44:17.170] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:48:0)
[12:44:17.170] Timer tick, asking Buildbucket for the build status
[12:44:17.953] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:44:17.953] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:49:0) after 1m0s
[12:45:18.013] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:49:0)
[12:45:18.013] Timer tick, asking Buildbucket for the build status
[12:45:18.812] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:45:18.812] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:50:0) after 1m0s
[12:46:27.848] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:50:0)
[12:46:27.848] Timer tick, asking Buildbucket for the build status
[12:46:27.933] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:46:27.933] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:51:0) after 1m0s
[12:47:27.951] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:51:0)
[12:47:27.951] Timer tick, asking Buildbucket for the build status
[12:47:28.265] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:47:28.265] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:52:0) after 1m0s
[12:48:28.261] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:52:0)
[12:48:28.261] Timer tick, asking Buildbucket for the build status
[12:48:28.332] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:48:28.332] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:53:0) after 1m0s
[12:49:28.347] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:53:0)
[12:49:28.347] Timer tick, asking Buildbucket for the build status
[12:49:28.442] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:49:28.442] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:54:0) after 1m0s
[12:50:28.474] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:54:0)
[12:50:28.474] Timer tick, asking Buildbucket for the build status
[12:50:28.567] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:50:28.567] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:55:0) after 1m0s
[12:51:28.583] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:55:0)
[12:51:28.583] Timer tick, asking Buildbucket for the build status
[12:51:28.662] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:51:28.662] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:56:0) after 1m0s
[12:52:28.691] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:56:0)
[12:52:28.691] Timer tick, asking Buildbucket for the build status
[12:52:28.759] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:52:28.759] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:57:0) after 1m0s
[12:53:28.777] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:57:0)
[12:53:28.777] Timer tick, asking Buildbucket for the build status
[12:53:28.870] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:53:28.870] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:58:0) after 1m0s
[12:54:28.890] Handling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:58:0)
[12:54:28.890] Timer tick, asking Buildbucket for the build status
[12:54:28.965] Build 8854053627478985856: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:54:28.965] Scheduling timer "check-buildbucket-build-status" (emscripten-releases/win:9019483690251606384:59:0) after 1m0s
[12:55:19.398] Received PubSub notification, asking Buildbucket for the build status
[12:55:19.488] Build 8854053627478985856: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[12:55:19.488] Buildbucket build:
{
  "build": {
    "bucket": "luci.emscripten-releases.ci",
    "canary_preference": "PROD",
    "completed_ts": "1614516918565550",
    "created_by": "project:emscripten-releases",
    "created_ts": "1614513481597274",
    "id": "8854053627478985856",
    "parameters_json": "{\"builder_name\": \"win\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/emscripten-releases\", \"revision\": \"f90c69a608ae8b0dba78b612dd09fcc8e4992a36\"}, \"id\": \"https://chromium.googlesource.com/emscripten-releases/+/refs/heads/master@f90c69a608ae8b0dba78b612dd09fcc8e4992a36\", \"title\": \"f90c69a608ae8b0dba78b612dd09fcc8e4992a36\", \"url\": \"https://chromium.googlesource.com/emscripten-releases/+/f90c69a608ae8b0dba78b612dd09fcc8e4992a36\"}]}, \"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/emscripten-releases\", \"revision\": \"f90c69a608ae8b0dba78b612dd09fcc8e4992a36\"}}",
    "project": "emscripten-releases",
    "result": "SUCCESS",
    "result_details_json": "{\"properties\": {\"$build/goma\": {\"enable_ats\": true, \"rpc_extra_params\": \"?prod\", \"server_host\": \"goma.chromium.org\"}, \"$recipe_engine/path\": {\"cache_dir\": \"C:\\\\b\\\\s\\\\w\\\\ir\\\\cache\", \"temp_dir\": \"C:\\\\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\": \"f90c69a608ae8b0dba78b612dd09fcc8e4992a36\"}, \"id\": \"https://chromium.googlesource.com/emscripten-releases/+/refs/heads/master@f90c69a608ae8b0dba78b612dd09fcc8e4992a36\", \"title\": \"f90c69a608ae8b0dba78b612dd09fcc8e4992a36\", \"url\": \"https://chromium.googlesource.com/emscripten-releases/+/f90c69a608ae8b0dba78b612dd09fcc8e4992a36\"}]}, \"bot_id\": \"luci-emscripten-releases-ci-win10-0-k9ya\", \"branch\": \"refs/heads/master\", \"buildername\": \"win\", \"got_revision\": \"f90c69a608ae8b0dba78b612dd09fcc8e4992a36\", \"path_config\": \"generic\", \"recipe\": \"emscripten_releases\", \"repository\": \"https://chromium.googlesource.com/emscripten-releases\", \"revision\": \"f90c69a608ae8b0dba78b612dd09fcc8e4992a36\"}, \"swarming\": {\"bot_dimensions\": {\"caches\": [\"builder_0175bca77590805533ed6e20351c9bfa7effd036e42d11a5b619a6ce75a8e486_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"8\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"host_class\": [\"default\"], \"id\": [\"luci-emscripten-releases-ci-win10-0-k9ya\"], \"image\": [\"chrome-win10-1703-20111600-a937a23cefb\"], \"integrity\": [\"high\"], \"locale\": [\"en_US.cp1252\"], \"machine_type\": [\"n1-standard-8\"], \"os\": [\"Windows\", \"Windows-10\", \"Windows-10-15063\"], \"pool\": [\"luci.emscripten-releases.ci\"], \"python\": [\"2.7.13\"], \"server_version\": [\"5712-339372b\"], \"ssd\": [\"0\"], \"windows_client_version\": [\"10\"], \"zone\": [\"us\", \"us-west\", \"us-west1\", \"us-west1-b\"]}}}",
    "service_account": "emscripten-releases-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
    "started_ts": "1614513515930754",
    "status": "COMPLETED",
    "status_changed_ts": "1614516918836187",
    "tags": [
      "builder:win",
      "buildset:commit/git/f90c69a608ae8b0dba78b612dd09fcc8e4992a36",
      "buildset:commit/gitiles/chromium.googlesource.com/emscripten-releases/+/f90c69a608ae8b0dba78b612dd09fcc8e4992a36",
      "gitiles_ref:refs/heads/master",
      "scheduler_invocation_id:9019483690251606384",
      "scheduler_job_id:emscripten-releases/win",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/emscripten-releases/buildbucket/cr-buildbucket.appspot.com/8854053627478985856/+/annotations",
      "swarming_tag:luci_project:emscripten-releases",
      "swarming_tag:os:Windows",
      "swarming_tag:recipe_name:emscripten_releases",
      "swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
      "swarming_task_id:52015232181f5510",
      "user_agent:luci-scheduler"
    ],
    "updated_ts": "1614516919060170",
    "url": "https://ci.chromium.org/b/8854053627478985856",
    "utcnow_ts": "1614516919474369"
  }
}
[12:55:19.488] Invocation finished in 57m19.918427297s with status SUCCEEDED