LUCI Scheduler :: nacl :: linux-pnacl-x86_64

Status: SUCCEEDED

Triggered by: -

Duration: 3 hours

Actions:

Definition (rev 1c82d86159c2071b02a7ddf08ffd2ae0bff92186)

buildbucket: <
  server: "cr-buildbucket.appspot.com"
  bucket: "luci.nacl.toolchain"
  builder: "linux-pnacl-x86_64"
>

Incoming triggers

4744a43b6fc4aaa5230541efad113b3cd86ea0f8 (5 years ago)

Incoming properties

{
  "branch": "refs/heads/master",
  "repository": "https://chromium.googlesource.com/native_client/src/native_client.git",
  "revision": "4744a43b6fc4aaa5230541efad113b3cd86ea0f8"
}

Incoming tags

buildset:commit/git/4744a43b6fc4aaa5230541efad113b3cd86ea0f8
buildset:commit/gitiles/chromium.googlesource.com/native_client/src/native_client/+/4744a43b6fc4aaa5230541efad113b3cd86ea0f8
gitiles_ref:refs/heads/master

Debug log (UTC)

[21:32:56.388] New invocation is queued and will start shortly
[21:32:57.485] Starting the invocation (attempt 1)
[21:32:57.530] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[21:32:57.530] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[21:32:57.530] Buildbucket request:
{
  "bucket": "luci.nacl.toolchain",
  "client_operation_id": "9078244948931359056",
  "parameters_json": "{\"builder_name\":\"linux-pnacl-x86_64\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/native_client/src/native_client.git\",\"revision\":\"4744a43b6fc4aaa5230541efad113b3cd86ea0f8\"}}",
  "pubsub_callback": {
    "auth_token": "...",
    "topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
  },
  "tags": [
    "builder:linux-pnacl-x86_64",
    "scheduler_invocation_id:9078244948931359056",
    "scheduler_job_id:nacl/linux-pnacl-x86_64",
    "user_agent:luci-scheduler",
    "buildset:commit/git/4744a43b6fc4aaa5230541efad113b3cd86ea0f8",
    "buildset:commit/gitiles/chromium.googlesource.com/native_client/src/native_client/+/4744a43b6fc4aaa5230541efad113b3cd86ea0f8",
    "gitiles_ref:refs/heads/master"
  ]
}
[21:32:58.781] Buildbucket response:
{
  "build": {
    "bucket": "luci.nacl.toolchain",
    "canary_preference": "AUTO",
    "created_by": "project:nacl",
    "created_ts": "1558474377644841",
    "id": "8912814886945334656",
    "parameters_json": "{\"builder_name\": \"linux-pnacl-x86_64\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/native_client/src/native_client.git\", \"revision\": \"4744a43b6fc4aaa5230541efad113b3cd86ea0f8\"}}",
    "project": "nacl",
    "result_details_json": "{\"properties\": {}}",
    "service_account": "nacl-toolchain-builder@chops-service-accounts.iam.gserviceaccount.com",
    "status": "SCHEDULED",
    "status_changed_ts": "1558474378545607",
    "tags": [
      "build_address:luci.nacl.toolchain/linux-pnacl-x86_64/7036",
      "builder:linux-pnacl-x86_64",
      "buildset:commit/git/4744a43b6fc4aaa5230541efad113b3cd86ea0f8",
      "buildset:commit/gitiles/chromium.googlesource.com/native_client/src/native_client/+/4744a43b6fc4aaa5230541efad113b3cd86ea0f8",
      "gitiles_ref:refs/heads/master",
      "scheduler_invocation_id:9078244948931359056",
      "scheduler_job_id:nacl/linux-pnacl-x86_64",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/nacl/buildbucket/cr-buildbucket.appspot.com/8912814886945334656/+/annotations",
      "swarming_tag:luci_project:nacl",
      "swarming_tag:recipe_name:nacl",
      "swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
      "swarming_task_id:",
      "user_agent:luci-scheduler"
    ],
    "updated_ts": "1558474378545754",
    "url": "https://ci.chromium.org/b/8912814886945334656",
    "utcnow_ts": "1558474378762840"
  }
}
[21:32:58.781] Task URL: https://ci.chromium.org/b/8912814886945334656
[21:32:58.781] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:2:0) after 1m0s
[21:33:19.729] Received PubSub notification, asking Buildbucket for the build status
[21:33:19.845] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:33:58.799] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:2:0)
[21:33:58.799] Timer tick, asking Buildbucket for the build status
[21:33:59.491] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:33:59.491] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:4:0) after 1m0s
[21:34:59.519] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:4:0)
[21:34:59.519] Timer tick, asking Buildbucket for the build status
[21:35:00.278] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:35:00.278] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:5:0) after 1m0s
[21:36:00.303] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:5:0)
[21:36:00.303] Timer tick, asking Buildbucket for the build status
[21:36:00.362] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:36:00.362] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:6:0) after 1m0s
[21:37:00.741] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:6:0)
[21:37:00.741] Timer tick, asking Buildbucket for the build status
[21:37:01.146] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:37:01.146] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:7:0) after 1m0s
[21:38:01.137] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:7:0)
[21:38:01.137] Timer tick, asking Buildbucket for the build status
[21:38:01.982] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:38:01.982] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:8:0) after 1m0s
[21:39:02.004] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:8:0)
[21:39:02.004] Timer tick, asking Buildbucket for the build status
[21:39:02.507] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:39:02.507] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:9:0) after 1m0s
[21:40:02.522] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:9:0)
[21:40:02.522] Timer tick, asking Buildbucket for the build status
[21:40:03.146] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:40:03.146] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:10:0) after 1m0s
[21:41:03.195] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:10:0)
[21:41:03.195] Timer tick, asking Buildbucket for the build status
[21:41:03.533] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:41:03.533] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:11:0) after 1m0s
[21:42:03.555] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:11:0)
[21:42:03.555] Timer tick, asking Buildbucket for the build status
[21:42:03.853] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:42:03.853] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:12:0) after 1m0s
[21:43:03.873] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:12:0)
[21:43:03.874] Timer tick, asking Buildbucket for the build status
[21:43:03.976] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:43:03.976] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:13:0) after 1m0s
[21:44:04.037] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:13:0)
[21:44:04.037] Timer tick, asking Buildbucket for the build status
[21:44:04.194] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:44:04.194] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:14:0) after 1m0s
[21:45:04.312] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:14:0)
[21:45:04.312] Timer tick, asking Buildbucket for the build status
[21:45:04.525] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:45:04.525] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:15:0) after 1m0s
[21:46:04.564] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:15:0)
[21:46:04.564] Timer tick, asking Buildbucket for the build status
[21:46:04.661] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:46:04.661] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:16:0) after 1m0s
[21:47:04.672] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:16:0)
[21:47:04.672] Timer tick, asking Buildbucket for the build status
[21:47:04.716] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:47:04.716] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:17:0) after 1m0s
[21:48:04.808] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:17:0)
[21:48:04.808] Timer tick, asking Buildbucket for the build status
[21:48:04.854] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:48:04.854] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:18:0) after 1m0s
[21:49:04.861] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:18:0)
[21:49:04.861] Timer tick, asking Buildbucket for the build status
[21:49:04.913] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:49:04.913] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:19:0) after 1m0s
[21:50:04.929] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:19:0)
[21:50:04.929] Timer tick, asking Buildbucket for the build status
[21:50:05.090] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:50:05.090] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:20:0) after 1m0s
[21:51:05.116] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:20:0)
[21:51:05.116] Timer tick, asking Buildbucket for the build status
[21:51:05.339] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:51:05.339] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:21:0) after 1m0s
[21:52:05.331] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:21:0)
[21:52:05.331] Timer tick, asking Buildbucket for the build status
[21:52:05.637] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:52:05.637] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:22:0) after 1m0s
[21:53:05.645] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:22:0)
[21:53:05.645] Timer tick, asking Buildbucket for the build status
[21:53:05.729] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:53:05.729] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:23:0) after 1m0s
[21:54:05.781] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:23:0)
[21:54:05.781] Timer tick, asking Buildbucket for the build status
[21:54:05.901] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:54:05.901] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:24:0) after 1m0s
[21:55:05.919] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:24:0)
[21:55:05.919] Timer tick, asking Buildbucket for the build status
[21:55:06.061] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:55:06.061] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:25:0) after 1m0s
[21:56:06.095] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:25:0)
[21:56:06.095] Timer tick, asking Buildbucket for the build status
[21:56:06.240] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:56:06.240] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:26:0) after 1m0s
[21:57:06.285] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:26:0)
[21:57:06.285] Timer tick, asking Buildbucket for the build status
[21:57:06.330] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:57:06.330] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:27:0) after 1m0s
[21:58:06.325] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:27:0)
[21:58:06.325] Timer tick, asking Buildbucket for the build status
[21:58:06.386] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:58:06.386] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:28:0) after 1m0s
[21:59:06.414] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:28:0)
[21:59:06.414] Timer tick, asking Buildbucket for the build status
[21:59:06.718] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:59:06.718] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:29:0) after 1m0s
[22:00:06.761] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:29:0)
[22:00:06.761] Timer tick, asking Buildbucket for the build status
[22:00:06.912] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:00:06.913] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:30:0) after 1m0s
[22:01:07.085] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:30:0)
[22:01:07.085] Timer tick, asking Buildbucket for the build status
[22:01:07.353] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:01:07.353] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:31:0) after 1m0s
[22:02:07.387] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:31:0)
[22:02:07.387] Timer tick, asking Buildbucket for the build status
[22:02:09.562] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:02:09.562] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:32:0) after 1m0s
[22:03:09.591] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:32:0)
[22:03:09.591] Timer tick, asking Buildbucket for the build status
[22:03:09.695] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:03:09.695] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:33:0) after 1m0s
[22:04:09.745] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:33:0)
[22:04:09.745] Timer tick, asking Buildbucket for the build status
[22:04:09.991] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:04:09.991] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:34:0) after 1m0s
[22:05:10.001] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:34:0)
[22:05:10.001] Timer tick, asking Buildbucket for the build status
[22:05:10.065] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:05:10.065] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:35:0) after 1m0s
[22:06:10.178] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:35:0)
[22:06:10.178] Timer tick, asking Buildbucket for the build status
[22:06:10.224] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:06:10.224] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:36:0) after 1m0s
[22:07:10.278] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:36:0)
[22:07:10.278] Timer tick, asking Buildbucket for the build status
[22:07:10.349] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:07:10.349] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:37:0) after 1m0s
[22:08:10.378] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:37:0)
[22:08:10.378] Timer tick, asking Buildbucket for the build status
[22:08:10.477] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:08:10.477] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:38:0) after 1m0s
[22:09:10.498] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:38:0)
[22:09:10.498] Timer tick, asking Buildbucket for the build status
[22:09:10.577] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:09:10.577] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:39:0) after 1m0s
[22:10:10.608] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:39:0)
[22:10:10.608] Timer tick, asking Buildbucket for the build status
[22:10:10.780] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:10:10.780] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:40:0) after 1m0s
[22:11:10.866] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:40:0)
[22:11:10.866] Timer tick, asking Buildbucket for the build status
[22:11:11.060] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:11:11.060] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:41:0) after 1m0s
[22:12:11.043] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:41:0)
[22:12:11.043] Timer tick, asking Buildbucket for the build status
[22:12:11.920] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:12:11.920] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:42:0) after 1m0s
[22:13:11.924] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:42:0)
[22:13:11.924] Timer tick, asking Buildbucket for the build status
[22:13:12.239] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:13:12.239] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:43:0) after 1m0s
[22:14:12.248] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:43:0)
[22:14:12.248] Timer tick, asking Buildbucket for the build status
[22:14:12.454] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:14:12.454] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:44:0) after 1m0s
[22:15:12.513] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:44:0)
[22:15:12.513] Timer tick, asking Buildbucket for the build status
[22:15:12.642] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:15:12.642] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:45:0) after 1m0s
[22:16:12.668] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:45:0)
[22:16:12.668] Timer tick, asking Buildbucket for the build status
[22:16:12.744] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:16:12.744] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:46:0) after 1m0s
[22:17:12.798] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:46:0)
[22:17:12.798] Timer tick, asking Buildbucket for the build status
[22:17:12.977] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:17:12.977] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:47:0) after 1m0s
[22:18:12.983] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:47:0)
[22:18:12.983] Timer tick, asking Buildbucket for the build status
[22:18:13.083] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:18:13.083] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:48:0) after 1m0s
[22:19:13.052] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:48:0)
[22:19:13.052] Timer tick, asking Buildbucket for the build status
[22:19:13.203] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:19:13.203] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:49:0) after 1m0s
[22:20:13.231] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:49:0)
[22:20:13.231] Timer tick, asking Buildbucket for the build status
[22:20:13.314] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:20:13.314] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:50:0) after 1m0s
[22:21:13.338] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:50:0)
[22:21:13.338] Timer tick, asking Buildbucket for the build status
[22:21:13.581] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:21:13.581] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:51:0) after 1m0s
[22:22:13.623] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:51:0)
[22:22:13.623] Timer tick, asking Buildbucket for the build status
[22:22:13.751] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:22:13.751] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:52:0) after 1m0s
[22:23:13.813] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:52:0)
[22:23:13.813] Timer tick, asking Buildbucket for the build status
[22:23:14.113] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:23:14.113] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:53:0) after 1m0s
[22:24:14.168] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:53:0)
[22:24:14.168] Timer tick, asking Buildbucket for the build status
[22:24:14.281] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:24:14.281] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:54:0) after 1m0s
[22:25:14.286] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:54:0)
[22:25:14.286] Timer tick, asking Buildbucket for the build status
[22:25:14.500] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:25:14.500] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:55:0) after 1m0s
[22:26:14.527] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:55:0)
[22:26:14.527] Timer tick, asking Buildbucket for the build status
[22:26:14.918] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:26:14.918] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:56:0) after 1m0s
[22:27:14.966] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:56:0)
[22:27:14.966] Timer tick, asking Buildbucket for the build status
[22:27:15.097] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:27:15.097] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:57:0) after 1m0s
[22:28:15.146] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:57:0)
[22:28:15.146] Timer tick, asking Buildbucket for the build status
[22:28:16.438] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:28:16.438] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:58:0) after 1m0s
[22:29:16.552] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:58:0)
[22:29:16.552] Timer tick, asking Buildbucket for the build status
[22:29:16.686] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:29:16.686] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:59:0) after 1m0s
[22:30:16.717] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:59:0)
[22:30:16.717] Timer tick, asking Buildbucket for the build status
[22:30:16.900] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:30:16.900] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:60:0) after 1m0s
[22:31:16.897] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:60:0)
[22:31:16.897] Timer tick, asking Buildbucket for the build status
[22:31:17.218] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:31:17.218] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:61:0) after 1m0s
[22:32:17.202] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:61:0)
[22:32:17.202] Timer tick, asking Buildbucket for the build status
[22:32:17.637] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:32:17.637] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:62:0) after 1m0s
[22:33:17.728] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:62:0)
[22:33:17.728] Timer tick, asking Buildbucket for the build status
[22:33:18.077] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:33:18.077] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:63:0) after 1m0s
[22:34:18.125] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:63:0)
[22:34:18.125] Timer tick, asking Buildbucket for the build status
[22:34:18.304] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:34:18.304] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:64:0) after 1m0s
[22:35:18.338] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:64:0)
[22:35:18.338] Timer tick, asking Buildbucket for the build status
[22:35:18.492] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:35:18.492] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:65:0) after 1m0s
[22:36:18.479] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:65:0)
[22:36:18.479] Timer tick, asking Buildbucket for the build status
[22:36:18.863] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:36:18.863] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:66:0) after 1m0s
[22:37:18.894] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:66:0)
[22:37:18.894] Timer tick, asking Buildbucket for the build status
[22:37:19.026] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:37:19.026] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:67:0) after 1m0s
[22:38:19.032] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:67:0)
[22:38:19.032] Timer tick, asking Buildbucket for the build status
[22:38:19.364] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:38:19.364] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:68:0) after 1m0s
[22:39:19.374] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:68:0)
[22:39:19.374] Timer tick, asking Buildbucket for the build status
[22:39:19.545] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:39:19.545] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:69:0) after 1m0s
[22:40:19.580] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:69:0)
[22:40:19.580] Timer tick, asking Buildbucket for the build status
[22:40:19.770] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:40:19.770] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:70:0) after 1m0s
[22:41:19.847] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:70:0)
[22:41:19.847] Timer tick, asking Buildbucket for the build status
[22:41:19.977] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:41:19.977] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:71:0) after 1m0s
[22:42:19.999] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:71:0)
[22:42:19.999] Timer tick, asking Buildbucket for the build status
[22:42:20.074] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:42:20.074] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:72:0) after 1m0s
[22:43:20.047] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:72:0)
[22:43:20.047] Timer tick, asking Buildbucket for the build status
[22:43:20.259] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:43:20.259] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:73:0) after 1m0s
[22:44:20.283] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:73:0)
[22:44:20.283] Timer tick, asking Buildbucket for the build status
[22:44:20.580] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:44:20.580] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:74:0) after 1m0s
[22:45:20.709] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:74:0)
[22:45:20.709] Timer tick, asking Buildbucket for the build status
[22:45:20.782] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:45:20.782] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:75:0) after 1m0s
[22:46:20.816] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:75:0)
[22:46:20.816] Timer tick, asking Buildbucket for the build status
[22:46:21.226] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:46:21.226] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:76:0) after 1m0s
[22:47:21.238] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:76:0)
[22:47:21.238] Timer tick, asking Buildbucket for the build status
[22:47:21.303] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:47:21.303] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:77:0) after 1m0s
[22:48:21.464] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:77:0)
[22:48:21.464] Timer tick, asking Buildbucket for the build status
[22:48:21.786] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:48:21.786] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:78:0) after 1m0s
[22:49:21.904] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:78:0)
[22:49:21.904] Timer tick, asking Buildbucket for the build status
[22:49:22.092] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:49:22.092] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:79:0) after 1m0s
[22:50:22.114] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:79:0)
[22:50:22.114] Timer tick, asking Buildbucket for the build status
[22:50:22.178] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:50:22.178] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:80:0) after 1m0s
[22:51:22.209] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:80:0)
[22:51:22.209] Timer tick, asking Buildbucket for the build status
[22:51:22.594] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:51:22.594] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:81:0) after 1m0s
[22:52:22.592] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:81:0)
[22:52:22.592] Timer tick, asking Buildbucket for the build status
[22:52:23.149] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:52:23.149] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:82:0) after 1m0s
[22:53:23.144] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:82:0)
[22:53:23.145] Timer tick, asking Buildbucket for the build status
[22:53:23.420] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:53:23.420] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:83:0) after 1m0s
[22:54:23.510] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:83:0)
[22:54:23.510] Timer tick, asking Buildbucket for the build status
[22:54:23.982] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:54:23.982] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:84:0) after 1m0s
[22:55:23.976] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:84:0)
[22:55:23.976] Timer tick, asking Buildbucket for the build status
[22:55:24.101] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:55:24.101] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:85:0) after 1m0s
[22:56:24.137] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:85:0)
[22:56:24.137] Timer tick, asking Buildbucket for the build status
[22:56:24.314] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:56:24.314] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:86:0) after 1m0s
[22:57:24.421] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:86:0)
[22:57:24.421] Timer tick, asking Buildbucket for the build status
[22:57:24.551] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:57:24.551] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:87:0) after 1m0s
[22:58:24.576] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:87:0)
[22:58:24.576] Timer tick, asking Buildbucket for the build status
[22:58:25.016] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:58:25.016] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:88:0) after 1m0s
[22:59:25.145] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:88:0)
[22:59:25.145] Timer tick, asking Buildbucket for the build status
[22:59:25.637] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:59:25.637] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:89:0) after 1m0s
[23:00:25.648] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:89:0)
[23:00:25.648] Timer tick, asking Buildbucket for the build status
[23:00:25.713] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:00:25.713] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:90:0) after 1m0s
[23:01:25.741] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:90:0)
[23:01:25.741] Timer tick, asking Buildbucket for the build status
[23:01:25.827] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:01:25.827] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:91:0) after 1m0s
[23:02:25.868] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:91:0)
[23:02:25.868] Timer tick, asking Buildbucket for the build status
[23:02:26.476] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:02:26.476] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:92:0) after 1m0s
[23:03:26.503] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:92:0)
[23:03:26.503] Timer tick, asking Buildbucket for the build status
[23:03:27.080] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:03:27.080] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:93:0) after 1m0s
[23:04:27.391] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:93:0)
[23:04:27.391] Timer tick, asking Buildbucket for the build status
[23:04:27.499] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:04:27.499] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:94:0) after 1m0s
[23:05:27.547] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:94:0)
[23:05:27.547] Timer tick, asking Buildbucket for the build status
[23:05:28.234] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:05:28.234] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:95:0) after 1m0s
[23:06:28.362] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:95:0)
[23:06:28.362] Timer tick, asking Buildbucket for the build status
[23:06:28.505] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:06:28.505] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:96:0) after 1m0s
[23:07:28.527] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:96:0)
[23:07:28.527] Timer tick, asking Buildbucket for the build status
[23:07:28.590] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:07:28.590] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:97:0) after 1m0s
[23:08:28.605] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:97:0)
[23:08:28.605] Timer tick, asking Buildbucket for the build status
[23:08:28.659] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:08:28.659] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:98:0) after 1m0s
[23:09:28.663] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:98:0)
[23:09:28.663] Timer tick, asking Buildbucket for the build status
[23:09:28.726] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:09:28.726] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:99:0) after 1m0s
[23:10:28.736] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:99:0)
[23:10:28.736] Timer tick, asking Buildbucket for the build status
[23:10:28.862] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:10:28.862] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:100:0) after 1m0s
[23:11:28.896] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:100:0)
[23:11:28.896] Timer tick, asking Buildbucket for the build status
[23:11:29.030] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:11:29.030] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:101:0) after 1m0s
[23:12:29.039] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:101:0)
[23:12:29.039] Timer tick, asking Buildbucket for the build status
[23:12:29.269] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:12:29.269] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:102:0) after 1m0s
[23:13:29.319] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:102:0)
[23:13:29.320] Timer tick, asking Buildbucket for the build status
[23:13:29.369] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:13:29.369] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:103:0) after 1m0s
[23:14:29.350] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:103:0)
[23:14:29.350] Timer tick, asking Buildbucket for the build status
[23:14:29.518] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:14:29.518] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:104:0) after 1m0s
[23:15:29.533] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:104:0)
[23:15:29.533] Timer tick, asking Buildbucket for the build status
[23:15:30.008] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:15:30.008] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:105:0) after 1m0s
[23:16:30.116] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:105:0)
[23:16:30.116] Timer tick, asking Buildbucket for the build status
[23:16:30.378] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:16:30.378] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:106:0) after 1m0s
[23:17:30.379] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:106:0)
[23:17:30.379] Timer tick, asking Buildbucket for the build status
[23:17:30.487] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:17:30.487] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:107:0) after 1m0s
[23:18:30.522] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:107:0)
[23:18:30.522] Timer tick, asking Buildbucket for the build status
[23:18:31.739] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:18:31.739] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:108:0) after 1m0s
[23:19:31.782] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:108:0)
[23:19:31.782] Timer tick, asking Buildbucket for the build status
[23:19:31.963] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:19:31.963] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:109:0) after 1m0s
[23:20:31.988] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:109:0)
[23:20:31.988] Timer tick, asking Buildbucket for the build status
[23:20:32.533] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:20:32.533] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:110:0) after 1m0s
[23:21:32.568] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:110:0)
[23:21:32.568] Timer tick, asking Buildbucket for the build status
[23:21:32.713] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:21:32.713] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:111:0) after 1m0s
[23:22:32.777] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:111:0)
[23:22:32.777] Timer tick, asking Buildbucket for the build status
[23:22:32.993] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:22:32.993] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:112:0) after 1m0s
[23:23:33.164] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:112:0)
[23:23:33.164] Timer tick, asking Buildbucket for the build status
[23:23:33.269] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:23:33.269] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:113:0) after 1m0s
[23:24:33.779] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:113:0)
[23:24:33.779] Timer tick, asking Buildbucket for the build status
[23:24:33.838] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:24:33.838] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:114:0) after 1m0s
[23:25:33.947] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:114:0)
[23:25:33.947] Timer tick, asking Buildbucket for the build status
[23:25:34.135] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:25:34.135] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:115:0) after 1m0s
[23:26:34.125] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:115:0)
[23:26:34.125] Timer tick, asking Buildbucket for the build status
[23:26:34.259] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:26:34.259] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:116:0) after 1m0s
[23:27:34.306] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:116:0)
[23:27:34.306] Timer tick, asking Buildbucket for the build status
[23:27:34.370] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:27:34.370] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:117:0) after 1m0s
[23:28:35.302] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:117:0)
[23:28:35.302] Timer tick, asking Buildbucket for the build status
[23:28:36.179] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:28:36.179] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:118:0) after 1m0s
[23:29:36.204] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:118:0)
[23:29:36.204] Timer tick, asking Buildbucket for the build status
[23:29:36.620] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:29:36.620] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:119:0) after 1m0s
[23:30:36.680] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:119:0)
[23:30:36.680] Timer tick, asking Buildbucket for the build status
[23:30:37.310] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:30:37.310] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:120:0) after 1m0s
[23:31:37.348] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:120:0)
[23:31:37.348] Timer tick, asking Buildbucket for the build status
[23:31:37.491] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:31:37.491] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:121:0) after 1m0s
[23:32:37.512] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:121:0)
[23:32:37.512] Timer tick, asking Buildbucket for the build status
[23:32:37.600] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:32:37.600] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:122:0) after 1m0s
[23:33:37.606] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:122:0)
[23:33:37.606] Timer tick, asking Buildbucket for the build status
[23:33:37.762] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:33:37.762] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:123:0) after 1m0s
[23:34:37.815] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:123:0)
[23:34:37.815] Timer tick, asking Buildbucket for the build status
[23:34:37.905] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:34:37.905] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:124:0) after 1m0s
[23:35:37.906] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:124:0)
[23:35:37.906] Timer tick, asking Buildbucket for the build status
[23:35:38.118] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:35:38.118] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:125:0) after 1m0s
[23:36:38.123] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:125:0)
[23:36:38.123] Timer tick, asking Buildbucket for the build status
[23:36:38.389] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:36:38.389] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:126:0) after 1m0s
[23:37:38.423] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:126:0)
[23:37:38.423] Timer tick, asking Buildbucket for the build status
[23:37:38.533] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:37:38.533] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:127:0) after 1m0s
[23:38:38.556] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:127:0)
[23:38:38.556] Timer tick, asking Buildbucket for the build status
[23:38:38.966] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:38:38.966] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:128:0) after 1m0s
[23:39:38.999] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:128:0)
[23:39:38.999] Timer tick, asking Buildbucket for the build status
[23:39:39.259] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:39:39.259] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:129:0) after 1m0s
[23:40:39.296] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:129:0)
[23:40:39.296] Timer tick, asking Buildbucket for the build status
[23:40:39.482] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:40:39.482] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:130:0) after 1m0s
[23:41:39.505] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:130:0)
[23:41:39.505] Timer tick, asking Buildbucket for the build status
[23:41:40.412] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:41:40.413] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:131:0) after 1m0s
[23:42:40.494] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:131:0)
[23:42:40.494] Timer tick, asking Buildbucket for the build status
[23:42:40.763] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:42:40.763] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:132:0) after 1m0s
[23:43:40.758] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:132:0)
[23:43:40.758] Timer tick, asking Buildbucket for the build status
[23:43:40.938] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:43:40.938] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:133:0) after 1m0s
[23:44:40.975] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:133:0)
[23:44:40.975] Timer tick, asking Buildbucket for the build status
[23:44:41.124] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:44:41.124] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:134:0) after 1m0s
[23:45:41.147] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:134:0)
[23:45:41.147] Timer tick, asking Buildbucket for the build status
[23:45:41.424] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:45:41.424] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:135:0) after 1m0s
[23:46:41.493] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:135:0)
[23:46:41.493] Timer tick, asking Buildbucket for the build status
[23:46:41.609] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:46:41.609] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:136:0) after 1m0s
[23:47:41.639] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:136:0)
[23:47:41.639] Timer tick, asking Buildbucket for the build status
[23:47:41.811] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:47:41.812] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:137:0) after 1m0s
[23:48:42.050] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:137:0)
[23:48:42.050] Timer tick, asking Buildbucket for the build status
[23:48:42.141] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:48:42.141] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:138:0) after 1m0s
[23:49:42.150] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:138:0)
[23:49:42.150] Timer tick, asking Buildbucket for the build status
[23:49:42.576] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:49:42.576] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:139:0) after 1m0s
[23:50:42.589] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:139:0)
[23:50:42.589] Timer tick, asking Buildbucket for the build status
[23:50:42.888] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:50:42.888] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:140:0) after 1m0s
[23:51:42.891] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:140:0)
[23:51:42.891] Timer tick, asking Buildbucket for the build status
[23:51:43.228] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:51:43.228] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:141:0) after 1m0s
[23:52:43.259] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:141:0)
[23:52:43.259] Timer tick, asking Buildbucket for the build status
[23:52:43.396] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:52:43.396] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:142:0) after 1m0s
[23:53:43.440] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:142:0)
[23:53:43.440] Timer tick, asking Buildbucket for the build status
[23:53:43.636] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:53:43.637] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:143:0) after 1m0s
[23:54:43.701] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:143:0)
[23:54:43.701] Timer tick, asking Buildbucket for the build status
[23:54:43.752] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:54:43.752] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:144:0) after 1m0s
[23:55:43.743] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:144:0)
[23:55:43.743] Timer tick, asking Buildbucket for the build status
[23:55:43.933] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:55:43.933] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:145:0) after 1m0s
[23:56:43.978] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:145:0)
[23:56:43.978] Timer tick, asking Buildbucket for the build status
[23:56:44.356] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:56:44.356] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:146:0) after 1m0s
[23:57:44.379] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:146:0)
[23:57:44.379] Timer tick, asking Buildbucket for the build status
[23:57:44.434] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:57:44.434] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:147:0) after 1m0s
[23:58:44.433] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:147:0)
[23:58:44.433] Timer tick, asking Buildbucket for the build status
[23:58:44.491] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:58:44.491] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:148:0) after 1m0s
[23:59:44.557] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:148:0)
[23:59:44.557] Timer tick, asking Buildbucket for the build status
[23:59:44.720] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:59:44.720] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:149:0) after 1m0s
[00:00:44.729] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:149:0)
[00:00:44.729] Timer tick, asking Buildbucket for the build status
[00:00:44.843] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:00:44.843] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:150:0) after 1m0s
[00:01:44.871] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:150:0)
[00:01:44.871] Timer tick, asking Buildbucket for the build status
[00:01:45.042] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:01:45.042] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:151:0) after 1m0s
[00:02:45.042] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:151:0)
[00:02:45.042] Timer tick, asking Buildbucket for the build status
[00:02:45.434] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:02:45.434] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:152:0) after 1m0s
[00:03:45.441] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:152:0)
[00:03:45.441] Timer tick, asking Buildbucket for the build status
[00:03:45.597] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:03:45.597] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:153:0) after 1m0s
[00:04:45.653] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:153:0)
[00:04:45.653] Timer tick, asking Buildbucket for the build status
[00:04:46.483] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:04:46.483] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:154:0) after 1m0s
[00:05:46.513] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:154:0)
[00:05:46.513] Timer tick, asking Buildbucket for the build status
[00:05:46.706] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:05:46.706] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:155:0) after 1m0s
[00:06:46.784] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:155:0)
[00:06:46.784] Timer tick, asking Buildbucket for the build status
[00:06:47.298] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:06:47.298] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:156:0) after 1m0s
[00:07:47.324] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:156:0)
[00:07:47.324] Timer tick, asking Buildbucket for the build status
[00:07:47.693] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:07:47.693] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:157:0) after 1m0s
[00:08:47.706] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:157:0)
[00:08:47.706] Timer tick, asking Buildbucket for the build status
[00:08:48.053] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:08:48.053] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:158:0) after 1m0s
[00:09:48.089] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:158:0)
[00:09:48.089] Timer tick, asking Buildbucket for the build status
[00:09:48.253] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:09:48.253] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:159:0) after 1m0s
[00:10:48.304] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:159:0)
[00:10:48.304] Timer tick, asking Buildbucket for the build status
[00:10:48.436] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:10:48.436] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:160:0) after 1m0s
[00:11:48.494] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:160:0)
[00:11:48.494] Timer tick, asking Buildbucket for the build status
[00:11:48.724] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:11:48.724] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:161:0) after 1m0s
[00:12:48.767] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:161:0)
[00:12:48.767] Timer tick, asking Buildbucket for the build status
[00:12:48.812] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:12:48.812] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:162:0) after 1m0s
[00:13:48.837] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:162:0)
[00:13:48.837] Timer tick, asking Buildbucket for the build status
[00:13:49.187] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:13:49.187] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:163:0) after 1m0s
[00:14:49.292] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:163:0)
[00:14:49.292] Timer tick, asking Buildbucket for the build status
[00:14:49.459] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:14:49.459] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:164:0) after 1m0s
[00:15:49.453] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:164:0)
[00:15:49.453] Timer tick, asking Buildbucket for the build status
[00:15:49.755] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:15:49.755] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:165:0) after 1m0s
[00:16:49.772] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:165:0)
[00:16:49.772] Timer tick, asking Buildbucket for the build status
[00:16:51.639] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:16:51.639] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:166:0) after 1m0s
[00:17:51.663] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:166:0)
[00:17:51.663] Timer tick, asking Buildbucket for the build status
[00:17:52.268] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:17:52.268] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:167:0) after 1m0s
[00:18:52.307] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:167:0)
[00:18:52.307] Timer tick, asking Buildbucket for the build status
[00:18:52.582] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:18:52.582] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:168:0) after 1m0s
[00:19:52.600] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:168:0)
[00:19:52.600] Timer tick, asking Buildbucket for the build status
[00:19:53.138] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:19:53.138] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:169:0) after 1m0s
[00:20:53.174] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:169:0)
[00:20:53.174] Timer tick, asking Buildbucket for the build status
[00:20:53.624] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:20:53.624] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:170:0) after 1m0s
[00:21:53.652] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:170:0)
[00:21:53.652] Timer tick, asking Buildbucket for the build status
[00:21:53.798] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:21:53.798] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:171:0) after 1m0s
[00:22:53.846] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:171:0)
[00:22:53.846] Timer tick, asking Buildbucket for the build status
[00:22:54.440] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:22:54.440] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:172:0) after 1m0s
[00:23:54.440] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:172:0)
[00:23:54.440] Timer tick, asking Buildbucket for the build status
[00:23:54.572] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:23:54.572] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:173:0) after 1m0s
[00:24:54.585] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:173:0)
[00:24:54.585] Timer tick, asking Buildbucket for the build status
[00:24:54.628] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:24:54.628] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:174:0) after 1m0s
[00:25:54.650] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:174:0)
[00:25:54.650] Timer tick, asking Buildbucket for the build status
[00:25:54.697] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:25:54.697] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:175:0) after 1m0s
[00:26:54.696] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:175:0)
[00:26:54.696] Timer tick, asking Buildbucket for the build status
[00:26:54.747] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:26:54.747] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:176:0) after 1m0s
[00:27:54.748] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:176:0)
[00:27:54.748] Timer tick, asking Buildbucket for the build status
[00:27:54.930] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:27:54.930] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:177:0) after 1m0s
[00:28:54.977] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:177:0)
[00:28:54.977] Timer tick, asking Buildbucket for the build status
[00:28:55.175] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:28:55.175] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:178:0) after 1m0s
[00:29:55.202] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:178:0)
[00:29:55.202] Timer tick, asking Buildbucket for the build status
[00:29:55.373] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:29:55.373] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:179:0) after 1m0s
[00:30:55.423] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:179:0)
[00:30:55.423] Timer tick, asking Buildbucket for the build status
[00:30:56.062] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:30:56.062] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:180:0) after 1m0s
[00:31:56.089] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:180:0)
[00:31:56.089] Timer tick, asking Buildbucket for the build status
[00:31:56.485] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:31:56.485] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:181:0) after 1m0s
[00:32:56.534] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:181:0)
[00:32:56.534] Timer tick, asking Buildbucket for the build status
[00:32:57.139] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:32:57.139] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:182:0) after 1m0s
[00:33:57.161] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:182:0)
[00:33:57.161] Timer tick, asking Buildbucket for the build status
[00:33:57.550] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:33:57.550] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:183:0) after 1m0s
[00:34:57.579] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:183:0)
[00:34:57.579] Timer tick, asking Buildbucket for the build status
[00:34:57.784] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:34:57.784] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:184:0) after 1m0s
[00:35:57.803] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:184:0)
[00:35:57.803] Timer tick, asking Buildbucket for the build status
[00:35:57.862] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:35:57.862] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:185:0) after 1m0s
[00:36:57.885] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:185:0)
[00:36:57.885] Timer tick, asking Buildbucket for the build status
[00:36:57.953] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:36:57.953] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:186:0) after 1m0s
[00:37:57.926] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:186:0)
[00:37:57.926] Timer tick, asking Buildbucket for the build status
[00:37:58.534] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:37:58.534] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:187:0) after 1m0s
[00:39:04.679] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:187:0)
[00:39:04.679] Timer tick, asking Buildbucket for the build status
[00:39:05.749] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:39:05.749] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:188:0) after 1m0s
[00:40:06.443] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:188:0)
[00:40:06.443] Timer tick, asking Buildbucket for the build status
[00:40:06.783] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:40:06.783] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:189:0) after 1m0s
[00:41:06.946] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:189:0)
[00:41:06.946] Timer tick, asking Buildbucket for the build status
[00:41:07.202] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:41:07.202] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:190:0) after 1m0s
[00:42:07.382] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:190:0)
[00:42:07.382] Timer tick, asking Buildbucket for the build status
[00:42:07.660] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:42:07.660] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:191:0) after 1m0s
[00:43:07.691] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:191:0)
[00:43:07.691] Timer tick, asking Buildbucket for the build status
[00:43:07.879] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:43:07.879] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:192:0) after 1m0s
[00:44:07.923] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:192:0)
[00:44:07.923] Timer tick, asking Buildbucket for the build status
[00:44:08.281] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:44:08.281] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:193:0) after 1m0s
[00:45:08.359] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:193:0)
[00:45:08.359] Timer tick, asking Buildbucket for the build status
[00:45:09.123] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:45:09.123] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:194:0) after 1m0s
[00:46:21.697] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:194:0)
[00:46:21.697] Timer tick, asking Buildbucket for the build status
[00:46:21.842] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:46:21.842] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:195:0) after 1m0s
[00:47:21.839] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:195:0)
[00:47:21.839] Timer tick, asking Buildbucket for the build status
[00:47:21.890] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:47:21.890] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:196:0) after 1m0s
[00:48:21.914] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:196:0)
[00:48:21.914] Timer tick, asking Buildbucket for the build status
[00:48:22.038] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:48:22.038] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:197:0) after 1m0s
[00:49:25.244] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:197:0)
[00:49:25.244] Timer tick, asking Buildbucket for the build status
[00:49:25.485] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:49:25.486] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:198:0) after 1m0s
[00:50:25.540] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:198:0)
[00:50:25.540] Timer tick, asking Buildbucket for the build status
[00:50:25.587] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:50:25.587] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:199:0) after 1m0s
[00:51:25.635] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:199:0)
[00:51:25.635] Timer tick, asking Buildbucket for the build status
[00:51:25.928] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:51:25.928] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:200:0) after 1m0s
[00:52:25.952] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:200:0)
[00:52:25.952] Timer tick, asking Buildbucket for the build status
[00:52:26.350] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:52:26.350] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:201:0) after 1m0s
[00:53:26.389] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:201:0)
[00:53:26.389] Timer tick, asking Buildbucket for the build status
[00:53:26.683] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:53:26.683] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:202:0) after 1m0s
[00:54:26.746] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:202:0)
[00:54:26.746] Timer tick, asking Buildbucket for the build status
[00:54:27.232] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:54:27.232] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:203:0) after 1m0s
[00:55:27.226] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:203:0)
[00:55:27.226] Timer tick, asking Buildbucket for the build status
[00:55:27.728] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:55:27.728] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:204:0) after 1m0s
[00:56:27.804] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:204:0)
[00:56:27.804] Timer tick, asking Buildbucket for the build status
[00:56:28.270] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:56:28.270] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:205:0) after 1m0s
[00:57:28.304] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:205:0)
[00:57:28.304] Timer tick, asking Buildbucket for the build status
[00:57:28.606] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:57:28.606] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:206:0) after 1m0s
[00:58:29.053] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:206:0)
[00:58:29.053] Timer tick, asking Buildbucket for the build status
[00:58:29.356] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:58:29.356] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:207:0) after 1m0s
[00:59:29.353] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:207:0)
[00:59:29.353] Timer tick, asking Buildbucket for the build status
[00:59:29.650] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:59:29.650] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:208:0) after 1m0s
[01:00:29.657] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:208:0)
[01:00:29.657] Timer tick, asking Buildbucket for the build status
[01:00:29.773] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:00:29.773] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:209:0) after 1m0s
[01:01:29.800] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:209:0)
[01:01:29.800] Timer tick, asking Buildbucket for the build status
[01:01:29.957] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:01:29.958] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:210:0) after 1m0s
[01:02:29.947] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:210:0)
[01:02:29.947] Timer tick, asking Buildbucket for the build status
[01:02:30.413] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:02:30.413] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:211:0) after 1m0s
[01:03:30.439] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:211:0)
[01:03:30.439] Timer tick, asking Buildbucket for the build status
[01:03:30.536] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:03:30.536] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:212:0) after 1m0s
[01:04:30.559] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:212:0)
[01:04:30.559] Timer tick, asking Buildbucket for the build status
[01:04:31.007] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:04:31.007] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:213:0) after 1m0s
[01:05:31.032] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:213:0)
[01:05:31.032] Timer tick, asking Buildbucket for the build status
[01:05:31.171] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:05:31.171] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:214:0) after 1m0s
[01:06:31.198] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:214:0)
[01:06:31.198] Timer tick, asking Buildbucket for the build status
[01:06:31.491] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:06:31.491] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:215:0) after 1m0s
[01:07:31.537] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:215:0)
[01:07:31.537] Timer tick, asking Buildbucket for the build status
[01:07:31.955] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:07:31.955] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:216:0) after 1m0s
[01:08:31.946] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:216:0)
[01:08:31.946] Timer tick, asking Buildbucket for the build status
[01:08:32.009] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:08:32.010] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:217:0) after 1m0s
[01:09:32.050] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:217:0)
[01:09:32.050] Timer tick, asking Buildbucket for the build status
[01:09:32.199] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:09:32.199] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:218:0) after 1m0s
[01:10:32.249] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:218:0)
[01:10:32.249] Timer tick, asking Buildbucket for the build status
[01:10:32.331] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:10:32.331] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:219:0) after 1m0s
[01:11:32.372] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:219:0)
[01:11:32.372] Timer tick, asking Buildbucket for the build status
[01:11:33.138] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:11:33.138] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:220:0) after 1m0s
[01:12:33.248] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:220:0)
[01:12:33.248] Timer tick, asking Buildbucket for the build status
[01:12:33.597] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:12:33.597] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:221:0) after 1m0s
[01:13:33.585] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:221:0)
[01:13:33.585] Timer tick, asking Buildbucket for the build status
[01:13:33.838] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:13:33.838] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:222:0) after 1m0s
[01:14:33.834] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:222:0)
[01:14:33.834] Timer tick, asking Buildbucket for the build status
[01:14:34.208] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:14:34.208] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:223:0) after 1m0s
[01:15:34.238] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:223:0)
[01:15:34.238] Timer tick, asking Buildbucket for the build status
[01:15:34.317] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:15:34.317] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:224:0) after 1m0s
[01:16:34.329] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:224:0)
[01:16:34.329] Timer tick, asking Buildbucket for the build status
[01:16:34.403] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:16:34.403] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:225:0) after 1m0s
[01:17:34.464] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:225:0)
[01:17:34.464] Timer tick, asking Buildbucket for the build status
[01:17:34.534] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:17:34.534] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:226:0) after 1m0s
[01:18:34.577] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:226:0)
[01:18:34.577] Timer tick, asking Buildbucket for the build status
[01:18:34.746] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:18:34.746] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:227:0) after 1m0s
[01:19:34.783] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:227:0)
[01:19:34.783] Timer tick, asking Buildbucket for the build status
[01:19:34.867] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:19:34.867] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:228:0) after 1m0s
[01:20:34.898] Handling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:228:0)
[01:20:34.898] Timer tick, asking Buildbucket for the build status
[01:20:35.338] Build 8912814886945334656: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:20:35.338] Scheduling timer "check-buildbucket-build-status" (nacl/linux-pnacl-x86_64:9078244948931359056:229:0) after 1m0s
[01:20:57.336] Received PubSub notification, asking Buildbucket for the build status
[01:20:57.788] Build 8912814886945334656: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[01:20:57.788] Buildbucket build:
{
  "build": {
    "bucket": "luci.nacl.toolchain",
    "canary_preference": "AUTO",
    "completed_ts": "1558488054581204",
    "created_by": "project:nacl",
    "created_ts": "1558474377644841",
    "id": "8912814886945334656",
    "parameters_json": "{\"builder_name\": \"linux-pnacl-x86_64\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/native_client/src/native_client.git\", \"revision\": \"4744a43b6fc4aaa5230541efad113b3cd86ea0f8\"}}",
    "project": "nacl",
    "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}, \"bot_id\": \"luci-nacl-toolchain-trusty-1-r3p8\", \"branch\": \"refs/heads/master\", \"buildername\": \"linux-pnacl-x86_64\", \"buildnumber\": 7036, \"got_revision\": \"4744a43b6fc4aaa5230541efad113b3cd86ea0f8\", \"mastername\": \"client.nacl.toolchain\", \"path_config\": \"generic\", \"recipe\": \"nacl\", \"repository\": \"https://chromium.googlesource.com/native_client/src/native_client.git\", \"revision\": \"4744a43b6fc4aaa5230541efad113b3cd86ea0f8\", \"slavetype\": \"BuilderTester\"}, \"swarming\": {\"bot_dimensions\": {\"cores\": [\"16\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gpu\": [\"none\"], \"id\": [\"luci-nacl-toolchain-trusty-1-r3p8\"], \"image\": [\"chrome-trusty-19041600-95c8804d634\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"machine_type\": [\"n1-standard-16\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-14.04\"], \"pool\": [\"luci.nacl.toolchain\"], \"python\": [\"2.7.6\"], \"server_version\": [\"4303-bae210e\"], \"zone\": [\"us\", \"us-east\", \"us-east1\", \"us-east1-b\"]}}}",
    "service_account": "nacl-toolchain-builder@chops-service-accounts.iam.gserviceaccount.com",
    "started_ts": "1558474398620605",
    "status": "COMPLETED",
    "status_changed_ts": "1558488056961579",
    "tags": [
      "build_address:luci.nacl.toolchain/linux-pnacl-x86_64/7036",
      "builder:linux-pnacl-x86_64",
      "buildset:commit/git/4744a43b6fc4aaa5230541efad113b3cd86ea0f8",
      "buildset:commit/gitiles/chromium.googlesource.com/native_client/src/native_client/+/4744a43b6fc4aaa5230541efad113b3cd86ea0f8",
      "gitiles_ref:refs/heads/master",
      "scheduler_invocation_id:9078244948931359056",
      "scheduler_job_id:nacl/linux-pnacl-x86_64",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/nacl/buildbucket/cr-buildbucket.appspot.com/8912814886945334656/+/annotations",
      "swarming_tag:luci_project:nacl",
      "swarming_tag:os:Linux",
      "swarming_tag:recipe_name:nacl",
      "swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
      "swarming_task_id:44f521597966e710",
      "user_agent:luci-scheduler"
    ],
    "updated_ts": "1558488056977367",
    "url": "https://ci.chromium.org/b/8912814886945334656",
    "utcnow_ts": "1558488057768518"
  }
}
[01:20:57.788] Invocation finished in 3h48m1.420697814s with status SUCCEEDED