buildbucket: <
  server: "cr-buildbucket.appspot.com"
  bucket: "luci.nacl.ci"
  builder: "linux-64-validator-opt"
>

• e2b3df265ebed5bccb0f5f670494bc800e7e3c1a (5 years ago)

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

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

[00:08:42.105] New invocation is queued and will start shortly
[00:08:45.141] Starting the invocation (attempt 1)
[00:08:45.172] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[00:08:45.172] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[00:08:45.172] Buildbucket request:
{
  "bucket": "luci.nacl.ci",
  "client_operation_id": "9052867998639096624",
  "parameters_json": "{\"builder_name\":\"linux-64-validator-opt\",\"properties\":{\"$recipe_engine/scheduler\":{\"hostname\":\"luci-scheduler.appspot.com\",\"triggers\":[{\"gitiles\":{\"ref\":\"refs/heads/master\",\"repo\":\"https://chromium.googlesource.com/native_client/src/native_client.git\",\"revision\":\"e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\"},\"id\":\"https://chromium.googlesource.com/native_client/src/native_client.git/+/refs/heads/master@e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\",\"title\":\"e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\",\"url\":\"https://chromium.googlesource.com/native_client/src/native_client.git/+/e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\"}]},\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/native_client/src/native_client.git\",\"revision\":\"e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\"}}",
  "pubsub_callback": {
    "auth_token": "...",
    "topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
  },
  "tags": [
    "builder:linux-64-validator-opt",
    "scheduler_invocation_id:9052867998639096624",
    "scheduler_job_id:nacl/linux-64-validator-opt",
    "user_agent:luci-scheduler",
    "buildset:commit/git/e2b3df265ebed5bccb0f5f670494bc800e7e3c1a",
    "buildset:commit/gitiles/chromium.googlesource.com/native_client/src/native_client/+/e2b3df265ebed5bccb0f5f670494bc800e7e3c1a",
    "gitiles_ref:refs/heads/master"
  ]
}
[00:08:46.414] Buildbucket response:
{
  "build": {
    "bucket": "luci.nacl.ci",
    "canary_preference": "PROD",
    "created_by": "project:nacl",
    "created_ts": "1582675725282889",
    "id": "8887437934645452320",
    "parameters_json": "{\"builder_name\": \"linux-64-validator-opt\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/native_client/src/native_client.git\", \"revision\": \"e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\"}, \"id\": \"https://chromium.googlesource.com/native_client/src/native_client.git/+/refs/heads/master@e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\", \"title\": \"e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\", \"url\": \"https://chromium.googlesource.com/native_client/src/native_client.git/+/e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\"}]}, \"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/native_client/src/native_client.git\", \"revision\": \"e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\"}}",
    "project": "nacl",
    "result_details_json": "{\"properties\": {}}",
    "service_account": "nacl-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
    "status": "SCHEDULED",
    "status_changed_ts": "1582675726085060",
    "tags": [
      "build_address:luci.nacl.ci/linux-64-validator-opt/118",
      "builder:linux-64-validator-opt",
      "buildset:commit/git/e2b3df265ebed5bccb0f5f670494bc800e7e3c1a",
      "buildset:commit/gitiles/chromium.googlesource.com/native_client/src/native_client/+/e2b3df265ebed5bccb0f5f670494bc800e7e3c1a",
      "gitiles_ref:refs/heads/master",
      "scheduler_invocation_id:9052867998639096624",
      "scheduler_job_id:nacl/linux-64-validator-opt",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/nacl/buildbucket/cr-buildbucket.appspot.com/8887437934645452320/+/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": "1582675726085232",
    "url": "https://ci.chromium.org/b/8887437934645452320",
    "utcnow_ts": "1582675726407248"
  }
}
[00:08:46.414] Task URL: https://ci.chromium.org/b/8887437934645452320
[00:08:46.414] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:2:0) after 1m0s
[00:09:46.680] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:2:0)
[00:09:46.680] Timer tick, asking Buildbucket for the build status
[00:09:46.949] Build 8887437934645452320: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[00:09:46.949] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:3:0) after 1m0s
[00:10:47.073] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:3:0)
[00:10:47.073] Timer tick, asking Buildbucket for the build status
[00:10:47.234] Build 8887437934645452320: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[00:10:47.234] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:4:0) after 1m0s
[00:11:47.320] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:4:0)
[00:11:47.320] Timer tick, asking Buildbucket for the build status
[00:11:47.428] Build 8887437934645452320: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[00:11:47.428] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:5:0) after 1m0s
[00:12:47.681] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:5:0)
[00:12:47.681] Timer tick, asking Buildbucket for the build status
[00:12:47.864] Build 8887437934645452320: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[00:12:47.864] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:6:0) after 1m0s
[00:13:47.901] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:6:0)
[00:13:47.901] Timer tick, asking Buildbucket for the build status
[00:13:48.074] Build 8887437934645452320: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[00:13:48.074] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:7:0) after 1m0s
[00:14:38.572] Received PubSub notification, asking Buildbucket for the build status
[00:14:38.874] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:14:48.163] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:7:0)
[00:14:48.163] Timer tick, asking Buildbucket for the build status
[00:14:48.233] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:14:48.234] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:9:0) after 1m0s
[00:15:48.317] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:9:0)
[00:15:48.317] Timer tick, asking Buildbucket for the build status
[00:15:48.867] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:15:48.867] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:10:0) after 1m0s
[00:16:48.973] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:10:0)
[00:16:48.973] Timer tick, asking Buildbucket for the build status
[00:16:49.293] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:16:49.293] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:11:0) after 1m0s
[00:17:49.413] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:11:0)
[00:17:49.413] Timer tick, asking Buildbucket for the build status
[00:17:49.585] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:17:49.585] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:12:0) after 1m0s
[00:18:49.669] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:12:0)
[00:18:49.669] Timer tick, asking Buildbucket for the build status
[00:18:49.831] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:18:49.831] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:13:0) after 1m0s
[00:19:49.880] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:13:0)
[00:19:49.880] Timer tick, asking Buildbucket for the build status
[00:19:49.989] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:19:49.989] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:14:0) after 1m0s
[00:20:50.063] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:14:0)
[00:20:50.063] Timer tick, asking Buildbucket for the build status
[00:20:50.220] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:20:50.220] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:15:0) after 1m0s
[00:21:50.383] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:15:0)
[00:21:50.383] Timer tick, asking Buildbucket for the build status
[00:21:50.834] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:21:50.834] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:16:0) after 1m0s
[00:22:50.914] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:16:0)
[00:22:50.914] Timer tick, asking Buildbucket for the build status
[00:22:51.055] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:22:51.055] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:17:0) after 1m0s
[00:23:51.076] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:17:0)
[00:23:51.076] Timer tick, asking Buildbucket for the build status
[00:23:51.606] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:23:51.606] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:18:0) after 1m0s
[00:24:51.681] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:18:0)
[00:24:51.681] Timer tick, asking Buildbucket for the build status
[00:24:51.808] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:24:51.808] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:19:0) after 1m0s
[00:25:51.898] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:19:0)
[00:25:51.898] Timer tick, asking Buildbucket for the build status
[00:25:52.006] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:25:52.006] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:20:0) after 1m0s
[00:26:52.107] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:20:0)
[00:26:52.107] Timer tick, asking Buildbucket for the build status
[00:26:52.581] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:26:52.581] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:21:0) after 1m0s
[00:27:52.725] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:21:0)
[00:27:52.725] Timer tick, asking Buildbucket for the build status
[00:27:52.884] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:27:52.884] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:22:0) after 1m0s
[00:28:52.859] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:22:0)
[00:28:52.859] Timer tick, asking Buildbucket for the build status
[00:28:53.680] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:28:53.680] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:23:0) after 1m0s
[00:29:53.731] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:23:0)
[00:29:53.731] Timer tick, asking Buildbucket for the build status
[00:29:53.884] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:29:53.884] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:24:0) after 1m0s
[00:30:53.926] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:24:0)
[00:30:53.926] Timer tick, asking Buildbucket for the build status
[00:30:54.052] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:30:54.052] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:25:0) after 1m0s
[00:31:54.074] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:25:0)
[00:31:54.074] Timer tick, asking Buildbucket for the build status
[00:31:54.145] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:31:54.145] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:26:0) after 1m0s
[00:32:54.173] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:26:0)
[00:32:54.173] Timer tick, asking Buildbucket for the build status
[00:32:54.351] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:32:54.351] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:27:0) after 1m0s
[00:33:54.566] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:27:0)
[00:33:54.566] Timer tick, asking Buildbucket for the build status
[00:33:54.793] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:33:54.793] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:28:0) after 1m0s
[00:34:54.922] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:28:0)
[00:34:54.922] Timer tick, asking Buildbucket for the build status
[00:34:55.017] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:34:55.018] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:29:0) after 1m0s
[00:35:55.161] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:29:0)
[00:35:55.161] Timer tick, asking Buildbucket for the build status
[00:35:55.377] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:35:55.377] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:30:0) after 1m0s
[00:36:55.471] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:30:0)
[00:36:55.471] Timer tick, asking Buildbucket for the build status
[00:36:55.582] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:36:55.582] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:31:0) after 1m0s
[00:37:55.586] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:31:0)
[00:37:55.586] Timer tick, asking Buildbucket for the build status
[00:37:55.678] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:37:55.678] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:32:0) after 1m0s
[00:38:55.694] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:32:0)
[00:38:55.694] Timer tick, asking Buildbucket for the build status
[00:38:55.787] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:38:55.787] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:33:0) after 1m0s
[00:39:55.894] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:33:0)
[00:39:55.894] Timer tick, asking Buildbucket for the build status
[00:39:56.014] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:39:56.014] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:34:0) after 1m0s
[00:40:56.031] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:34:0)
[00:40:56.031] Timer tick, asking Buildbucket for the build status
[00:40:56.299] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:40:56.299] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:35:0) after 1m0s
[00:41:56.328] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:35:0)
[00:41:56.328] Timer tick, asking Buildbucket for the build status
[00:41:56.583] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:41:56.583] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:36:0) after 1m0s
[00:42:56.742] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:36:0)
[00:42:56.742] Timer tick, asking Buildbucket for the build status
[00:42:57.015] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:42:57.015] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:37:0) after 1m0s
[00:52:16.162] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:37:0)
[00:52:16.162] Timer tick, asking Buildbucket for the build status
[00:52:16.334] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:52:16.334] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:38:0) after 1m0s
[00:53:16.355] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:38:0)
[00:53:16.355] Timer tick, asking Buildbucket for the build status
[00:53:16.463] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:53:16.463] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:39:0) after 1m0s
[00:54:16.472] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:39:0)
[00:54:16.472] Timer tick, asking Buildbucket for the build status
[00:54:16.827] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:54:16.827] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:40:0) after 1m0s
[00:55:16.814] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:40:0)
[00:55:16.814] Timer tick, asking Buildbucket for the build status
[00:55:16.928] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:55:16.928] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:41:0) after 1m0s
[00:56:17.001] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:41:0)
[00:56:17.001] Timer tick, asking Buildbucket for the build status
[00:56:17.370] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:56:17.370] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:42:0) after 1m0s
[00:57:17.416] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:42:0)
[00:57:17.416] Timer tick, asking Buildbucket for the build status
[00:57:17.547] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:57:17.547] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:43:0) after 1m0s
[00:58:17.657] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:43:0)
[00:58:17.657] Timer tick, asking Buildbucket for the build status
[00:58:17.762] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:58:17.762] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:44:0) after 1m0s
[00:59:17.995] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:44:0)
[00:59:17.996] Timer tick, asking Buildbucket for the build status
[00:59:18.132] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:59:18.132] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:45:0) after 1m0s
[01:00:18.189] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:45:0)
[01:00:18.189] Timer tick, asking Buildbucket for the build status
[01:00:18.309] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:00:18.309] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:46:0) after 1m0s
[01:01:18.343] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:46:0)
[01:01:18.343] Timer tick, asking Buildbucket for the build status
[01:01:18.553] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:01:18.553] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:47:0) after 1m0s
[01:02:18.607] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:47:0)
[01:02:18.607] Timer tick, asking Buildbucket for the build status
[01:02:18.719] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:02:18.719] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:48:0) after 1m0s
[01:03:18.741] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:48:0)
[01:03:18.741] Timer tick, asking Buildbucket for the build status
[01:03:18.859] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:03:18.859] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:49:0) after 1m0s
[01:04:18.889] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:49:0)
[01:04:18.889] Timer tick, asking Buildbucket for the build status
[01:04:19.039] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:04:19.039] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:50:0) after 1m0s
[01:05:19.076] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:50:0)
[01:05:19.076] Timer tick, asking Buildbucket for the build status
[01:05:19.421] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:05:19.421] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:51:0) after 1m0s
[01:06:19.406] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:51:0)
[01:06:19.406] Timer tick, asking Buildbucket for the build status
[01:06:19.591] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:06:19.591] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:52:0) after 1m0s
[01:07:19.649] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:52:0)
[01:07:19.649] Timer tick, asking Buildbucket for the build status
[01:07:19.755] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:07:19.755] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:53:0) after 1m0s
[01:08:19.779] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:53:0)
[01:08:19.779] Timer tick, asking Buildbucket for the build status
[01:08:19.897] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:08:19.897] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:54:0) after 1m0s
[01:09:20.011] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:54:0)
[01:09:20.011] Timer tick, asking Buildbucket for the build status
[01:09:20.184] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:09:20.184] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:55:0) after 1m0s
[01:10:20.393] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:55:0)
[01:10:20.393] Timer tick, asking Buildbucket for the build status
[01:10:20.675] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:10:20.675] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:56:0) after 1m0s
[01:11:20.908] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:56:0)
[01:11:20.908] Timer tick, asking Buildbucket for the build status
[01:11:21.154] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:11:21.154] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:57:0) after 1m0s
[01:12:21.187] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:57:0)
[01:12:21.187] Timer tick, asking Buildbucket for the build status
[01:12:21.676] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:12:21.676] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:58:0) after 1m0s
[01:13:21.754] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:58:0)
[01:13:21.754] Timer tick, asking Buildbucket for the build status
[01:13:22.283] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:13:22.283] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:59:0) after 1m0s
[01:14:22.426] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:59:0)
[01:14:22.426] Timer tick, asking Buildbucket for the build status
[01:14:22.715] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:14:22.715] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:60:0) after 1m0s
[01:15:22.866] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:60:0)
[01:15:22.866] Timer tick, asking Buildbucket for the build status
[01:15:23.227] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:15:23.227] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:61:0) after 1m0s
[01:16:23.298] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:61:0)
[01:16:23.298] Timer tick, asking Buildbucket for the build status
[01:16:23.666] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:16:23.666] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:62:0) after 1m0s
[01:17:23.692] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:62:0)
[01:17:23.692] Timer tick, asking Buildbucket for the build status
[01:17:23.815] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:17:23.815] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:63:0) after 1m0s
[01:18:23.868] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:63:0)
[01:18:23.868] Timer tick, asking Buildbucket for the build status
[01:18:23.957] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:18:23.957] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:64:0) after 1m0s
[01:19:24.012] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:64:0)
[01:19:24.012] Timer tick, asking Buildbucket for the build status
[01:19:24.141] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:19:24.141] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:65:0) after 1m0s
[01:20:24.126] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:65:0)
[01:20:24.126] Timer tick, asking Buildbucket for the build status
[01:20:24.352] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:20:24.352] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:66:0) after 1m0s
[01:21:24.391] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:66:0)
[01:21:24.391] Timer tick, asking Buildbucket for the build status
[01:21:25.783] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:21:25.783] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:67:0) after 1m0s
[01:22:25.803] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:67:0)
[01:22:25.803] Timer tick, asking Buildbucket for the build status
[01:22:27.653] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:22:27.653] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:68:0) after 1m0s
[01:23:27.790] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:68:0)
[01:23:27.790] Timer tick, asking Buildbucket for the build status
[01:23:28.171] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:23:28.171] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:69:0) after 1m0s
[01:24:28.363] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:69:0)
[01:24:28.363] Timer tick, asking Buildbucket for the build status
[01:24:28.485] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:24:28.485] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:70:0) after 1m0s
[01:25:28.632] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:70:0)
[01:25:28.632] Timer tick, asking Buildbucket for the build status
[01:25:28.953] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:25:28.953] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:71:0) after 1m0s
[01:26:28.978] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:71:0)
[01:26:28.978] Timer tick, asking Buildbucket for the build status
[01:26:29.294] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:26:29.294] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:72:0) after 1m0s
[01:27:29.384] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:72:0)
[01:27:29.384] Timer tick, asking Buildbucket for the build status
[01:27:29.540] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:27:29.540] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:73:0) after 1m0s
[01:28:29.701] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:73:0)
[01:28:29.701] Timer tick, asking Buildbucket for the build status
[01:28:29.881] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:28:29.881] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:74:0) after 1m0s
[01:29:29.967] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:74:0)
[01:29:29.967] Timer tick, asking Buildbucket for the build status
[01:29:30.366] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:29:30.366] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:75:0) after 1m0s
[01:30:30.485] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:75:0)
[01:30:30.485] Timer tick, asking Buildbucket for the build status
[01:30:30.606] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:30:30.606] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:76:0) after 1m0s
[01:31:30.676] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:76:0)
[01:31:30.676] Timer tick, asking Buildbucket for the build status
[01:31:30.806] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:31:30.806] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:77:0) after 1m0s
[01:32:30.928] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:77:0)
[01:32:30.928] Timer tick, asking Buildbucket for the build status
[01:32:31.080] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:32:31.080] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:78:0) after 1m0s
[01:33:31.125] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:78:0)
[01:33:31.125] Timer tick, asking Buildbucket for the build status
[01:33:31.381] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:33:31.381] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:79:0) after 1m0s
[01:34:31.503] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:79:0)
[01:34:31.503] Timer tick, asking Buildbucket for the build status
[01:34:31.614] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:34:31.614] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:80:0) after 1m0s
[01:35:31.654] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:80:0)
[01:35:31.654] Timer tick, asking Buildbucket for the build status
[01:35:31.954] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:35:31.954] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:81:0) after 1m0s
[01:36:32.069] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:81:0)
[01:36:32.069] Timer tick, asking Buildbucket for the build status
[01:36:32.509] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:36:32.509] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:82:0) after 1m0s
[01:37:32.519] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:82:0)
[01:37:32.519] Timer tick, asking Buildbucket for the build status
[01:37:32.745] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:37:32.745] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:83:0) after 1m0s
[01:38:32.805] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:83:0)
[01:38:32.805] Timer tick, asking Buildbucket for the build status
[01:38:32.904] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:38:32.904] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:84:0) after 1m0s
[01:39:32.891] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:84:0)
[01:39:32.891] Timer tick, asking Buildbucket for the build status
[01:39:33.206] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:39:33.206] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:85:0) after 1m0s
[01:40:33.299] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:85:0)
[01:40:33.299] Timer tick, asking Buildbucket for the build status
[01:40:33.442] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:40:33.442] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:86:0) after 1m0s
[01:41:33.473] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:86:0)
[01:41:33.473] Timer tick, asking Buildbucket for the build status
[01:41:33.960] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:41:33.960] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:87:0) after 1m0s
[01:42:34.020] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:87:0)
[01:42:34.020] Timer tick, asking Buildbucket for the build status
[01:42:34.896] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:42:34.896] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:88:0) after 1m0s
[01:43:35.000] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:88:0)
[01:43:35.001] Timer tick, asking Buildbucket for the build status
[01:43:35.119] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:43:35.119] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:89:0) after 1m0s
[01:44:35.102] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:89:0)
[01:44:35.102] Timer tick, asking Buildbucket for the build status
[01:44:35.202] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:44:35.202] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:90:0) after 1m0s
[01:45:35.228] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:90:0)
[01:45:35.228] Timer tick, asking Buildbucket for the build status
[01:45:35.499] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:45:35.499] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:91:0) after 1m0s
[01:46:35.536] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:91:0)
[01:46:35.536] Timer tick, asking Buildbucket for the build status
[01:46:35.632] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:46:35.632] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:92:0) after 1m0s
[01:47:35.677] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:92:0)
[01:47:35.677] Timer tick, asking Buildbucket for the build status
[01:47:36.061] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:47:36.061] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:93:0) after 1m0s
[01:48:36.134] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:93:0)
[01:48:36.134] Timer tick, asking Buildbucket for the build status
[01:48:36.466] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:48:36.466] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:94:0) after 1m0s
[01:49:36.583] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:94:0)
[01:49:36.583] Timer tick, asking Buildbucket for the build status
[01:49:36.742] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:49:36.742] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:95:0) after 1m0s
[01:50:36.882] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:95:0)
[01:50:36.882] Timer tick, asking Buildbucket for the build status
[01:50:37.008] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:50:37.008] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:96:0) after 1m0s
[01:51:37.095] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:96:0)
[01:51:37.095] Timer tick, asking Buildbucket for the build status
[01:51:37.217] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:51:37.217] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:97:0) after 1m0s
[01:52:37.243] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:97:0)
[01:52:37.243] Timer tick, asking Buildbucket for the build status
[01:52:37.405] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:52:37.405] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:98:0) after 1m0s
[01:53:37.468] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:98:0)
[01:53:37.468] Timer tick, asking Buildbucket for the build status
[01:53:37.554] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:53:37.554] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:99:0) after 1m0s
[01:54:37.611] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:99:0)
[01:54:37.611] Timer tick, asking Buildbucket for the build status
[01:54:37.848] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:54:37.848] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:100:0) after 1m0s
[01:55:37.833] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:100:0)
[01:55:37.833] Timer tick, asking Buildbucket for the build status
[01:55:37.949] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:55:37.949] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:101:0) after 1m0s
[01:56:37.949] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:101:0)
[01:56:37.949] Timer tick, asking Buildbucket for the build status
[01:56:38.072] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:56:38.072] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:102:0) after 1m0s
[01:57:38.117] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:102:0)
[01:57:38.117] Timer tick, asking Buildbucket for the build status
[01:57:38.271] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:57:38.271] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:103:0) after 1m0s
[01:58:38.439] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:103:0)
[01:58:38.440] Timer tick, asking Buildbucket for the build status
[01:58:39.705] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:58:39.705] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:104:0) after 1m0s
[01:59:39.766] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:104:0)
[01:59:39.766] Timer tick, asking Buildbucket for the build status
[01:59:39.971] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:59:39.971] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:105:0) after 1m0s
[02:00:39.997] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:105:0)
[02:00:39.997] Timer tick, asking Buildbucket for the build status
[02:00:40.126] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:00:40.126] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:106:0) after 1m0s
[02:01:40.172] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:106:0)
[02:01:40.172] Timer tick, asking Buildbucket for the build status
[02:01:40.679] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:01:40.679] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:107:0) after 1m0s
[02:02:40.830] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:107:0)
[02:02:40.830] Timer tick, asking Buildbucket for the build status
[02:02:41.003] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:02:41.003] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:108:0) after 1m0s
[02:03:41.126] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:108:0)
[02:03:41.126] Timer tick, asking Buildbucket for the build status
[02:03:41.284] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:03:41.284] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:109:0) after 1m0s
[02:04:41.370] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:109:0)
[02:04:41.370] Timer tick, asking Buildbucket for the build status
[02:04:41.481] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:04:41.481] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:110:0) after 1m0s
[02:05:41.633] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:110:0)
[02:05:41.633] Timer tick, asking Buildbucket for the build status
[02:05:41.907] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:05:41.915] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:111:0) after 1m0s
[02:06:42.054] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:111:0)
[02:06:42.054] Timer tick, asking Buildbucket for the build status
[02:06:42.270] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:06:42.270] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:112:0) after 1m0s
[02:07:42.328] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:112:0)
[02:07:42.328] Timer tick, asking Buildbucket for the build status
[02:07:42.488] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:07:42.488] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:113:0) after 1m0s
[02:08:42.540] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:113:0)
[02:08:42.540] Timer tick, asking Buildbucket for the build status
[02:08:42.651] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:08:42.651] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:114:0) after 1m0s
[02:09:42.785] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:114:0)
[02:09:42.785] Timer tick, asking Buildbucket for the build status
[02:09:43.230] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:09:43.230] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:115:0) after 1m0s
[02:10:43.291] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:115:0)
[02:10:43.291] Timer tick, asking Buildbucket for the build status
[02:10:43.375] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:10:43.375] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:116:0) after 1m0s
[02:11:43.418] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:116:0)
[02:11:43.418] Timer tick, asking Buildbucket for the build status
[02:11:43.629] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:11:43.629] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:117:0) after 1m0s
[02:12:43.733] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:117:0)
[02:12:43.733] Timer tick, asking Buildbucket for the build status
[02:12:43.842] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:12:43.842] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:118:0) after 1m0s
[02:13:43.997] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:118:0)
[02:13:43.997] Timer tick, asking Buildbucket for the build status
[02:13:44.353] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:13:44.353] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:119:0) after 1m0s
[02:14:44.500] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:119:0)
[02:14:44.500] Timer tick, asking Buildbucket for the build status
[02:14:44.606] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:14:44.606] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:120:0) after 1m0s
[02:15:44.751] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:120:0)
[02:15:44.751] Timer tick, asking Buildbucket for the build status
[02:15:44.874] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:15:44.874] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:121:0) after 1m0s
[02:16:44.975] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:121:0)
[02:16:44.975] Timer tick, asking Buildbucket for the build status
[02:16:45.086] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:16:45.086] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:122:0) after 1m0s
[02:17:45.105] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:122:0)
[02:17:45.105] Timer tick, asking Buildbucket for the build status
[02:17:45.229] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:17:45.229] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:123:0) after 1m0s
[02:18:45.256] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:123:0)
[02:18:45.256] Timer tick, asking Buildbucket for the build status
[02:18:45.365] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:18:45.365] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:124:0) after 1m0s
[02:19:45.443] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:124:0)
[02:19:45.443] Timer tick, asking Buildbucket for the build status
[02:19:45.716] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:19:45.716] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:125:0) after 1m0s
[02:20:45.781] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:125:0)
[02:20:45.781] Timer tick, asking Buildbucket for the build status
[02:20:45.889] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:20:45.889] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:126:0) after 1m0s
[02:21:45.868] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:126:0)
[02:21:45.868] Timer tick, asking Buildbucket for the build status
[02:21:46.069] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:21:46.069] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:127:0) after 1m0s
[02:22:46.263] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:127:0)
[02:22:46.263] Timer tick, asking Buildbucket for the build status
[02:22:46.493] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:22:46.493] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:128:0) after 1m0s
[02:23:46.738] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:128:0)
[02:23:46.738] Timer tick, asking Buildbucket for the build status
[02:23:47.202] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:23:47.203] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:129:0) after 1m0s
[02:24:47.365] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:129:0)
[02:24:47.365] Timer tick, asking Buildbucket for the build status
[02:24:47.453] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:24:47.453] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:130:0) after 1m0s
[02:25:47.580] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:130:0)
[02:25:47.580] Timer tick, asking Buildbucket for the build status
[02:25:47.713] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:25:47.713] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:131:0) after 1m0s
[02:26:47.793] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:131:0)
[02:26:47.793] Timer tick, asking Buildbucket for the build status
[02:26:47.945] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:26:47.945] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:132:0) after 1m0s
[02:27:48.156] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:132:0)
[02:27:48.156] Timer tick, asking Buildbucket for the build status
[02:27:48.267] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:27:48.267] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:133:0) after 1m0s
[02:28:48.406] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:133:0)
[02:28:48.406] Timer tick, asking Buildbucket for the build status
[02:28:48.502] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:28:48.503] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:134:0) after 1m0s
[02:29:48.621] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:134:0)
[02:29:48.622] Timer tick, asking Buildbucket for the build status
[02:29:48.787] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:29:48.787] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:135:0) after 1m0s
[02:30:48.799] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:135:0)
[02:30:48.799] Timer tick, asking Buildbucket for the build status
[02:30:49.189] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:30:49.189] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:136:0) after 1m0s
[02:31:49.314] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:136:0)
[02:31:49.314] Timer tick, asking Buildbucket for the build status
[02:31:49.508] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:31:49.508] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:137:0) after 1m0s
[02:32:49.710] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:137:0)
[02:32:49.710] Timer tick, asking Buildbucket for the build status
[02:32:49.798] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:32:49.798] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:138:0) after 1m0s
[02:33:49.866] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:138:0)
[02:33:49.866] Timer tick, asking Buildbucket for the build status
[02:33:50.113] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:33:50.113] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:139:0) after 1m0s
[02:34:50.146] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:139:0)
[02:34:50.146] Timer tick, asking Buildbucket for the build status
[02:34:50.281] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:34:50.281] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:140:0) after 1m0s
[02:35:50.381] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:140:0)
[02:35:50.381] Timer tick, asking Buildbucket for the build status
[02:35:50.483] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:35:50.483] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:141:0) after 1m0s
[02:36:50.564] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:141:0)
[02:36:50.564] Timer tick, asking Buildbucket for the build status
[02:36:50.716] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:36:50.716] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:142:0) after 1m0s
[02:37:50.823] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:142:0)
[02:37:50.823] Timer tick, asking Buildbucket for the build status
[02:37:50.978] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:37:50.978] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:143:0) after 1m0s
[02:38:51.052] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:143:0)
[02:38:51.052] Timer tick, asking Buildbucket for the build status
[02:38:51.181] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:38:51.181] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:144:0) after 1m0s
[02:39:51.280] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:144:0)
[02:39:51.281] Timer tick, asking Buildbucket for the build status
[02:39:51.602] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:39:51.602] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:145:0) after 1m0s
[02:40:51.662] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:145:0)
[02:40:51.662] Timer tick, asking Buildbucket for the build status
[02:40:51.784] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:40:51.784] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:146:0) after 1m0s
[02:41:51.929] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:146:0)
[02:41:51.929] Timer tick, asking Buildbucket for the build status
[02:41:52.037] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:41:52.037] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:147:0) after 1m0s
[02:42:52.123] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:147:0)
[02:42:52.123] Timer tick, asking Buildbucket for the build status
[02:42:52.229] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:42:52.229] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:148:0) after 1m0s
[02:43:52.414] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:148:0)
[02:43:52.414] Timer tick, asking Buildbucket for the build status
[02:43:52.591] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:43:52.591] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:149:0) after 1m0s
[02:44:52.667] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:149:0)
[02:44:52.667] Timer tick, asking Buildbucket for the build status
[02:44:52.895] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:44:52.896] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:150:0) after 1m0s
[02:45:52.919] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:150:0)
[02:45:52.919] Timer tick, asking Buildbucket for the build status
[02:45:53.156] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:45:53.156] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:151:0) after 1m0s
[02:46:53.236] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:151:0)
[02:46:53.236] Timer tick, asking Buildbucket for the build status
[02:46:53.664] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:46:53.664] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:152:0) after 1m0s
[02:47:53.729] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:152:0)
[02:47:53.729] Timer tick, asking Buildbucket for the build status
[02:47:53.930] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:47:53.930] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:153:0) after 1m0s
[02:48:53.932] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:153:0)
[02:48:53.932] Timer tick, asking Buildbucket for the build status
[02:48:54.175] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:48:54.175] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:154:0) after 1m0s
[02:49:54.238] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:154:0)
[02:49:54.238] Timer tick, asking Buildbucket for the build status
[02:49:54.423] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:49:54.423] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:155:0) after 1m0s
[02:50:54.468] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:155:0)
[02:50:54.468] Timer tick, asking Buildbucket for the build status
[02:50:54.653] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:50:54.653] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:156:0) after 1m0s
[02:51:54.765] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:156:0)
[02:51:54.765] Timer tick, asking Buildbucket for the build status
[02:51:54.922] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:51:54.922] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:157:0) after 1m0s
[02:52:54.950] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:157:0)
[02:52:54.950] Timer tick, asking Buildbucket for the build status
[02:52:55.252] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:52:55.252] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:158:0) after 1m0s
[02:53:55.304] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:158:0)
[02:53:55.304] Timer tick, asking Buildbucket for the build status
[02:53:55.430] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:53:55.430] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:159:0) after 1m0s
[02:54:55.544] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:159:0)
[02:54:55.544] Timer tick, asking Buildbucket for the build status
[02:54:55.764] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:54:55.764] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:160:0) after 1m0s
[02:55:55.799] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:160:0)
[02:55:55.799] Timer tick, asking Buildbucket for the build status
[02:55:55.965] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:55:55.965] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:161:0) after 1m0s
[02:56:56.099] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:161:0)
[02:56:56.099] Timer tick, asking Buildbucket for the build status
[02:56:56.190] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:56:56.190] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:162:0) after 1m0s
[02:57:56.255] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:162:0)
[02:57:56.255] Timer tick, asking Buildbucket for the build status
[02:57:56.389] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:57:56.389] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:163:0) after 1m0s
[02:58:56.463] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:163:0)
[02:58:56.463] Timer tick, asking Buildbucket for the build status
[02:58:56.740] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:58:56.740] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:164:0) after 1m0s
[02:59:56.784] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:164:0)
[02:59:56.784] Timer tick, asking Buildbucket for the build status
[02:59:56.909] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:59:56.909] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:165:0) after 1m0s
[03:00:56.959] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:165:0)
[03:00:56.959] Timer tick, asking Buildbucket for the build status
[03:00:57.082] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:00:57.082] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:166:0) after 1m0s
[03:01:57.185] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:166:0)
[03:01:57.185] Timer tick, asking Buildbucket for the build status
[03:01:57.278] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:01:57.278] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:167:0) after 1m0s
[03:02:57.429] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:167:0)
[03:02:57.429] Timer tick, asking Buildbucket for the build status
[03:02:57.579] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:02:57.579] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:168:0) after 1m0s
[03:03:57.611] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:168:0)
[03:03:57.611] Timer tick, asking Buildbucket for the build status
[03:03:57.741] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:03:57.741] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:169:0) after 1m0s
[03:04:57.924] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:169:0)
[03:04:57.925] Timer tick, asking Buildbucket for the build status
[03:04:58.076] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:04:58.076] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:170:0) after 1m0s
[03:05:58.176] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:170:0)
[03:05:58.176] Timer tick, asking Buildbucket for the build status
[03:05:58.285] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:05:58.285] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:171:0) after 1m0s
[03:06:58.357] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:171:0)
[03:06:58.357] Timer tick, asking Buildbucket for the build status
[03:06:58.465] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:06:58.465] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:172:0) after 1m0s
[03:07:58.495] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:172:0)
[03:07:58.495] Timer tick, asking Buildbucket for the build status
[03:07:58.598] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:07:58.598] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:173:0) after 1m0s
[03:08:58.628] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:173:0)
[03:08:58.628] Timer tick, asking Buildbucket for the build status
[03:08:58.815] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:08:58.815] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:174:0) after 1m0s
[03:09:58.906] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:174:0)
[03:09:58.906] Timer tick, asking Buildbucket for the build status
[03:09:59.127] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:09:59.127] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:175:0) after 1m0s
[03:10:59.178] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:175:0)
[03:10:59.178] Timer tick, asking Buildbucket for the build status
[03:10:59.276] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:10:59.276] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:176:0) after 1m0s
[03:11:59.326] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:176:0)
[03:11:59.326] Timer tick, asking Buildbucket for the build status
[03:11:59.449] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:11:59.449] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:177:0) after 1m0s
[03:12:59.482] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:177:0)
[03:12:59.482] Timer tick, asking Buildbucket for the build status
[03:12:59.846] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:12:59.846] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:178:0) after 1m0s
[03:13:59.912] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:178:0)
[03:13:59.912] Timer tick, asking Buildbucket for the build status
[03:14:00.236] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:14:00.236] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:179:0) after 1m0s
[03:15:00.384] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:179:0)
[03:15:00.384] Timer tick, asking Buildbucket for the build status
[03:15:00.777] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:15:00.777] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:180:0) after 1m0s
[03:16:00.974] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:180:0)
[03:16:00.974] Timer tick, asking Buildbucket for the build status
[03:16:01.354] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:16:01.354] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:181:0) after 1m0s
[03:17:01.420] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:181:0)
[03:17:01.420] Timer tick, asking Buildbucket for the build status
[03:17:01.586] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:17:01.587] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:182:0) after 1m0s
[03:18:01.814] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:182:0)
[03:18:01.814] Timer tick, asking Buildbucket for the build status
[03:18:02.043] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:18:02.043] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:183:0) after 1m0s
[03:19:02.151] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:183:0)
[03:19:02.151] Timer tick, asking Buildbucket for the build status
[03:19:02.256] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:19:02.256] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:184:0) after 1m0s
[03:20:02.332] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:184:0)
[03:20:02.332] Timer tick, asking Buildbucket for the build status
[03:20:02.596] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:20:02.596] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:185:0) after 1m0s
[03:21:02.640] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:185:0)
[03:21:02.640] Timer tick, asking Buildbucket for the build status
[03:21:03.033] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:21:03.033] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:186:0) after 1m0s
[03:22:03.110] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:186:0)
[03:22:03.110] Timer tick, asking Buildbucket for the build status
[03:22:03.248] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:22:03.248] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:187:0) after 1m0s
[03:23:03.284] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:187:0)
[03:23:03.284] Timer tick, asking Buildbucket for the build status
[03:23:03.408] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:23:03.408] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:188:0) after 1m0s
[03:24:03.460] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:188:0)
[03:24:03.460] Timer tick, asking Buildbucket for the build status
[03:24:03.719] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:24:03.719] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:189:0) after 1m0s
[03:25:03.755] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:189:0)
[03:25:03.755] Timer tick, asking Buildbucket for the build status
[03:25:03.861] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:25:03.861] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:190:0) after 1m0s
[03:26:04.118] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:190:0)
[03:26:04.118] Timer tick, asking Buildbucket for the build status
[03:26:04.257] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:26:04.257] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:191:0) after 1m0s
[03:27:04.473] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:191:0)
[03:27:04.473] Timer tick, asking Buildbucket for the build status
[03:27:04.571] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:27:04.571] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:192:0) after 1m0s
[03:28:04.757] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:192:0)
[03:28:04.757] Timer tick, asking Buildbucket for the build status
[03:28:04.883] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:28:04.883] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:193:0) after 1m0s
[03:29:04.980] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:193:0)
[03:29:04.980] Timer tick, asking Buildbucket for the build status
[03:29:05.096] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:29:05.096] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:194:0) after 1m0s
[03:30:05.231] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:194:0)
[03:30:05.231] Timer tick, asking Buildbucket for the build status
[03:30:05.375] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:30:05.375] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:195:0) after 1m0s
[03:31:05.461] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:195:0)
[03:31:05.461] Timer tick, asking Buildbucket for the build status
[03:31:05.625] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:31:05.625] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:196:0) after 1m0s
[03:32:05.682] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:196:0)
[03:32:05.682] Timer tick, asking Buildbucket for the build status
[03:32:06.139] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:32:06.139] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:197:0) after 1m0s
[03:33:06.395] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:197:0)
[03:33:06.396] Timer tick, asking Buildbucket for the build status
[03:33:06.662] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:33:06.662] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:198:0) after 1m0s
[03:34:06.700] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:198:0)
[03:34:06.700] Timer tick, asking Buildbucket for the build status
[03:34:06.811] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:34:06.811] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:199:0) after 1m0s
[03:35:07.324] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:199:0)
[03:35:07.324] Timer tick, asking Buildbucket for the build status
[03:35:07.599] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:35:07.599] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:200:0) after 1m0s
[03:36:07.900] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:200:0)
[03:36:07.900] Timer tick, asking Buildbucket for the build status
[03:36:08.051] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:36:08.051] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:201:0) after 1m0s
[03:37:08.191] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:201:0)
[03:37:08.191] Timer tick, asking Buildbucket for the build status
[03:37:08.446] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:37:08.446] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:202:0) after 1m0s
[03:38:08.607] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:202:0)
[03:38:08.607] Timer tick, asking Buildbucket for the build status
[03:38:08.723] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:38:08.723] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:203:0) after 1m0s
[03:39:08.804] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:203:0)
[03:39:08.804] Timer tick, asking Buildbucket for the build status
[03:39:08.904] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:39:08.904] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:204:0) after 1m0s
[03:40:09.133] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:204:0)
[03:40:09.133] Timer tick, asking Buildbucket for the build status
[03:40:09.311] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:40:09.311] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:205:0) after 1m0s
[03:41:09.405] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:205:0)
[03:41:09.405] Timer tick, asking Buildbucket for the build status
[03:41:09.518] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:41:09.518] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:206:0) after 1m0s
[03:42:09.790] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:206:0)
[03:42:09.790] Timer tick, asking Buildbucket for the build status
[03:42:10.021] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:42:10.021] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:207:0) after 1m0s
[03:43:10.227] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:207:0)
[03:43:10.227] Timer tick, asking Buildbucket for the build status
[03:43:10.381] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:43:10.381] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:208:0) after 1m0s
[03:44:10.454] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:208:0)
[03:44:10.454] Timer tick, asking Buildbucket for the build status
[03:44:10.605] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:44:10.606] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:209:0) after 1m0s
[03:45:10.862] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:209:0)
[03:45:10.862] Timer tick, asking Buildbucket for the build status
[03:45:11.059] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:45:11.059] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:210:0) after 1m0s
[03:46:11.331] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:210:0)
[03:46:11.331] Timer tick, asking Buildbucket for the build status
[03:46:11.487] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:46:11.487] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:211:0) after 1m0s
[03:47:11.530] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:211:0)
[03:47:11.530] Timer tick, asking Buildbucket for the build status
[03:47:12.936] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:47:12.936] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:212:0) after 1m0s
[03:48:12.998] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:212:0)
[03:48:12.998] Timer tick, asking Buildbucket for the build status
[03:48:15.614] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:48:15.614] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:213:0) after 1m0s
[03:49:15.722] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:213:0)
[03:49:15.722] Timer tick, asking Buildbucket for the build status
[03:49:15.820] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:49:15.820] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:214:0) after 1m0s
[03:50:15.856] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:214:0)
[03:50:15.857] Timer tick, asking Buildbucket for the build status
[03:50:16.348] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:50:16.350] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:215:0) after 1m0s
[03:51:16.446] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:215:0)
[03:51:16.446] Timer tick, asking Buildbucket for the build status
[03:51:16.543] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:51:16.543] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:216:0) after 1m0s
[03:52:16.588] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:216:0)
[03:52:16.588] Timer tick, asking Buildbucket for the build status
[03:52:17.020] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:52:17.020] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:217:0) after 1m0s
[03:53:17.075] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:217:0)
[03:53:17.075] Timer tick, asking Buildbucket for the build status
[03:53:17.185] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:53:17.185] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:218:0) after 1m0s
[03:54:17.264] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:218:0)
[03:54:17.264] Timer tick, asking Buildbucket for the build status
[03:54:17.387] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:54:17.388] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:219:0) after 1m0s
[03:55:17.533] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:219:0)
[03:55:17.533] Timer tick, asking Buildbucket for the build status
[03:55:17.626] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:55:17.626] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:220:0) after 1m0s
[03:56:17.722] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:220:0)
[03:56:17.722] Timer tick, asking Buildbucket for the build status
[03:56:17.945] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:56:17.945] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:221:0) after 1m0s
[03:57:18.142] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:221:0)
[03:57:18.142] Timer tick, asking Buildbucket for the build status
[03:57:18.281] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:57:18.282] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:222:0) after 1m0s
[03:58:18.508] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:222:0)
[03:58:18.508] Timer tick, asking Buildbucket for the build status
[03:58:18.640] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:58:18.640] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:223:0) after 1m0s
[03:59:18.960] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:223:0)
[03:59:18.960] Timer tick, asking Buildbucket for the build status
[03:59:19.103] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:59:19.103] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:224:0) after 1m0s
[04:00:19.296] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:224:0)
[04:00:19.296] Timer tick, asking Buildbucket for the build status
[04:00:19.391] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:00:19.391] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:225:0) after 1m0s
[04:01:19.474] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:225:0)
[04:01:19.474] Timer tick, asking Buildbucket for the build status
[04:01:19.731] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:01:19.731] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:226:0) after 1m0s
[04:02:19.936] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:226:0)
[04:02:19.936] Timer tick, asking Buildbucket for the build status
[04:02:20.189] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:02:20.189] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:227:0) after 1m0s
[04:03:20.240] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:227:0)
[04:03:20.240] Timer tick, asking Buildbucket for the build status
[04:03:20.478] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:03:20.478] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:228:0) after 1m0s
[04:04:20.714] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:228:0)
[04:04:20.717] Timer tick, asking Buildbucket for the build status
[04:04:21.109] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:04:21.109] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:229:0) after 1m0s
[04:05:21.362] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:229:0)
[04:05:21.362] Timer tick, asking Buildbucket for the build status
[04:05:21.482] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:05:21.482] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:230:0) after 1m0s
[04:06:21.618] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:230:0)
[04:06:21.618] Timer tick, asking Buildbucket for the build status
[04:06:22.073] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:06:22.073] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:231:0) after 1m0s
[04:07:22.092] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:231:0)
[04:07:22.092] Timer tick, asking Buildbucket for the build status
[04:07:22.247] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:07:22.247] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:232:0) after 1m0s
[04:08:22.359] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:232:0)
[04:08:22.359] Timer tick, asking Buildbucket for the build status
[04:08:22.579] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:08:22.579] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:233:0) after 1m0s
[04:09:22.655] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:233:0)
[04:09:22.655] Timer tick, asking Buildbucket for the build status
[04:09:22.775] Build 8887437934645452320: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:09:22.775] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9052867998639096624:234:0) after 1m0s
[04:09:31.351] Received PubSub notification, asking Buildbucket for the build status
[04:09:31.414] Build 8887437934645452320: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[04:09:31.414] Buildbucket build:
{
  "build": {
    "bucket": "luci.nacl.ci",
    "canary_preference": "PROD",
    "completed_ts": "1582690170757873",
    "created_by": "project:nacl",
    "created_ts": "1582675725282889",
    "failure_reason": "BUILD_FAILURE",
    "id": "8887437934645452320",
    "parameters_json": "{\"builder_name\": \"linux-64-validator-opt\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/native_client/src/native_client.git\", \"revision\": \"e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\"}, \"id\": \"https://chromium.googlesource.com/native_client/src/native_client.git/+/refs/heads/master@e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\", \"title\": \"e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\", \"url\": \"https://chromium.googlesource.com/native_client/src/native_client.git/+/e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\"}]}, \"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/native_client/src/native_client.git\", \"revision\": \"e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\"}}",
    "project": "nacl",
    "result": "FAILURE",
    "result_details_json": "{\"error\": {\"message\": \"Step('annotated steps') (retcode: 1)\"}, \"properties\": {\"$recipe_engine/path\": {\"cache_dir\": \"/b/s/w/ir/cache\", \"temp_dir\": \"/b/s/w/ir/tmp/rt\"}, \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://chromium.googlesource.com/native_client/src/native_client.git\", \"revision\": \"e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\"}, \"id\": \"https://chromium.googlesource.com/native_client/src/native_client.git/+/refs/heads/master@e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\", \"title\": \"e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\", \"url\": \"https://chromium.googlesource.com/native_client/src/native_client.git/+/e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\"}]}, \"bot_id\": \"luci-flex-ci-xenial-6-yop5\", \"branch\": \"refs/heads/master\", \"buildername\": \"linux-64-validator-opt\", \"buildnumber\": 118, \"got_revision\": \"e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\", \"mastername\": \"client.nacl\", \"path_config\": \"generic\", \"recipe\": \"nacl\", \"repository\": \"https://chromium.googlesource.com/native_client/src/native_client.git\", \"revision\": \"e2b3df265ebed5bccb0f5f670494bc800e7e3c1a\", \"slavetype\": \"BuilderTester\"}, \"swarming\": {\"bot_dimensions\": {\"caches\": [\"git\", \"goma_v2\", \"infra_gclient_with_go\", \"vpython\"], \"cores\": [\"8\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"luci-flex-ci-xenial-6-yop5\"], \"image\": [\"chrome-xenial-20012600-8e1a7e485b7\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"n1-standard-8\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-16.04\"], \"pool\": [\"luci.flex.ci\"], \"python\": [\"2.7.12\"], \"server_version\": [\"4825-3d129d6\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-west\", \"us-west1\", \"us-west1-b\"]}}, \"ui\": {\"info\": \"Step('annotated steps') (retcode: 1)\"}}",
    "service_account": "nacl-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
    "started_ts": "1582676077954617",
    "status": "COMPLETED",
    "status_changed_ts": "1582676078269747",
    "tags": [
      "build_address:luci.nacl.ci/linux-64-validator-opt/118",
      "builder:linux-64-validator-opt",
      "buildset:commit/git/e2b3df265ebed5bccb0f5f670494bc800e7e3c1a",
      "buildset:commit/gitiles/chromium.googlesource.com/native_client/src/native_client/+/e2b3df265ebed5bccb0f5f670494bc800e7e3c1a",
      "gitiles_ref:refs/heads/master",
      "scheduler_invocation_id:9052867998639096624",
      "scheduler_job_id:nacl/linux-64-validator-opt",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/nacl/buildbucket/cr-buildbucket.appspot.com/8887437934645452320/+/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:4a97a4987fabb210",
      "user_agent:luci-scheduler"
    ],
    "updated_ts": "1582690170841380",
    "url": "https://ci.chromium.org/b/8887437934645452320",
    "utcnow_ts": "1582690171402925"
  }
}
[04:09:31.414] Invocation finished in 4h0m49.325075056s with status FAILED