LUCI Scheduler :: nacl :: linux-64-validator-opt

Status: SUCCEEDED

Triggered by: -

Duration: 6 hours

Actions:

Definition (rev 8fecfaafc1abba4843234d58a712c5811f9e1de9)

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

Incoming triggers

d304d90ecc17351ce0fdab3e7452052a469c0976 (5 years ago)

Incoming properties

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

Incoming tags

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

Debug log (UTC)

[22:53:08.714] New invocation is queued and will start shortly
[22:53:09.852] Starting the invocation (attempt 1)
[22:53:09.904] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[22:53:09.904] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[22:53:09.904] Buildbucket request:
{
  "bucket": "luci.nacl.ci",
  "client_operation_id": "9049430067523534528",
  "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\":\"d304d90ecc17351ce0fdab3e7452052a469c0976\"},\"id\":\"https://chromium.googlesource.com/native_client/src/native_client.git/+/refs/heads/master@d304d90ecc17351ce0fdab3e7452052a469c0976\",\"title\":\"d304d90ecc17351ce0fdab3e7452052a469c0976\",\"url\":\"https://chromium.googlesource.com/native_client/src/native_client.git/+/d304d90ecc17351ce0fdab3e7452052a469c0976\"}]},\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/native_client/src/native_client.git\",\"revision\":\"d304d90ecc17351ce0fdab3e7452052a469c0976\"}}",
  "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:9049430067523534528",
    "scheduler_job_id:nacl/linux-64-validator-opt",
    "user_agent:luci-scheduler",
    "buildset:commit/git/d304d90ecc17351ce0fdab3e7452052a469c0976",
    "buildset:commit/gitiles/chromium.googlesource.com/native_client/src/native_client/+/d304d90ecc17351ce0fdab3e7452052a469c0976",
    "gitiles_ref:refs/heads/master"
  ]
}
[22:53:10.970] Buildbucket response:
{
  "build": {
    "bucket": "luci.nacl.ci",
    "canary": true,
    "canary_preference": "CANARY",
    "created_by": "project:nacl",
    "created_ts": "1585954390023140",
    "id": "8884000005485750080",
    "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\": \"d304d90ecc17351ce0fdab3e7452052a469c0976\"}, \"id\": \"https://chromium.googlesource.com/native_client/src/native_client.git/+/refs/heads/master@d304d90ecc17351ce0fdab3e7452052a469c0976\", \"title\": \"d304d90ecc17351ce0fdab3e7452052a469c0976\", \"url\": \"https://chromium.googlesource.com/native_client/src/native_client.git/+/d304d90ecc17351ce0fdab3e7452052a469c0976\"}]}, \"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/native_client/src/native_client.git\", \"revision\": \"d304d90ecc17351ce0fdab3e7452052a469c0976\"}}",
    "project": "nacl",
    "result_details_json": "{\"properties\": {}}",
    "service_account": "nacl-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
    "status": "SCHEDULED",
    "status_changed_ts": "1585954390728531",
    "tags": [
      "build_address:luci.nacl.ci/linux-64-validator-opt/136",
      "builder:linux-64-validator-opt",
      "buildset:commit/git/d304d90ecc17351ce0fdab3e7452052a469c0976",
      "buildset:commit/gitiles/chromium.googlesource.com/native_client/src/native_client/+/d304d90ecc17351ce0fdab3e7452052a469c0976",
      "gitiles_ref:refs/heads/master",
      "scheduler_invocation_id:9049430067523534528",
      "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/8884000005485750080/+/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": "1585954390728744",
    "url": "https://ci.chromium.org/b/8884000005485750080",
    "utcnow_ts": "1585954390945731"
  }
}
[22:53:10.970] Task URL: https://ci.chromium.org/b/8884000005485750080
[22:53:10.970] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:2:0) after 1m0s
[22:53:17.915] Received PubSub notification, asking Buildbucket for the build status
[22:53:18.022] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:54:10.974] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:2:0)
[22:54:10.974] Timer tick, asking Buildbucket for the build status
[22:54:11.139] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:54:11.139] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:4:0) after 1m0s
[22:55:11.172] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:4:0)
[22:55:11.172] Timer tick, asking Buildbucket for the build status
[22:55:11.605] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:55:11.605] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:5:0) after 1m0s
[22:56:11.631] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:5:0)
[22:56:11.631] Timer tick, asking Buildbucket for the build status
[22:56:11.971] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:56:11.971] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:6:0) after 1m0s
[22:57:12.023] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:6:0)
[22:57:12.023] Timer tick, asking Buildbucket for the build status
[22:57:12.182] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:57:12.182] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:7:0) after 1m0s
[22:58:12.155] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:7:0)
[22:58:12.155] Timer tick, asking Buildbucket for the build status
[22:58:12.442] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:58:12.442] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:8:0) after 1m0s
[22:59:12.525] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:8:0)
[22:59:12.525] Timer tick, asking Buildbucket for the build status
[22:59:12.855] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:59:12.855] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:9:0) after 1m0s
[23:00:12.918] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:9:0)
[23:00:12.918] Timer tick, asking Buildbucket for the build status
[23:00:13.276] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:00:13.276] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:10:0) after 1m0s
[23:01:13.297] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:10:0)
[23:01:13.297] Timer tick, asking Buildbucket for the build status
[23:01:13.638] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:01:13.638] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:11:0) after 1m0s
[23:02:13.662] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:11:0)
[23:02:13.662] Timer tick, asking Buildbucket for the build status
[23:02:13.845] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:02:13.845] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:12:0) after 1m0s
[23:03:13.955] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:12:0)
[23:03:13.955] Timer tick, asking Buildbucket for the build status
[23:03:14.122] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:03:14.122] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:13:0) after 1m0s
[23:04:14.182] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:13:0)
[23:04:14.182] Timer tick, asking Buildbucket for the build status
[23:04:14.346] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:04:14.346] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:14:0) after 1m0s
[23:05:14.405] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:14:0)
[23:05:14.405] Timer tick, asking Buildbucket for the build status
[23:05:14.731] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:05:14.731] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:15:0) after 1m0s
[23:06:14.815] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:15:0)
[23:06:14.815] Timer tick, asking Buildbucket for the build status
[23:06:14.974] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:06:14.974] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:16:0) after 1m0s
[23:07:15.029] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:16:0)
[23:07:15.029] Timer tick, asking Buildbucket for the build status
[23:07:15.300] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:07:15.301] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:17:0) after 1m0s
[23:08:15.333] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:17:0)
[23:08:15.333] Timer tick, asking Buildbucket for the build status
[23:08:15.572] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:08:15.572] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:18:0) after 1m0s
[23:09:15.603] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:18:0)
[23:09:15.603] Timer tick, asking Buildbucket for the build status
[23:09:16.081] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:09:16.082] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:19:0) after 1m0s
[23:10:16.077] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:19:0)
[23:10:16.077] Timer tick, asking Buildbucket for the build status
[23:10:16.258] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:10:16.258] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:20:0) after 1m0s
[23:11:16.305] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:20:0)
[23:11:16.305] Timer tick, asking Buildbucket for the build status
[23:11:16.415] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:11:16.415] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:21:0) after 1m0s
[23:12:16.412] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:21:0)
[23:12:16.412] Timer tick, asking Buildbucket for the build status
[23:12:16.562] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:12:16.562] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:22:0) after 1m0s
[23:13:16.619] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:22:0)
[23:13:16.619] Timer tick, asking Buildbucket for the build status
[23:13:16.776] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:13:16.776] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:23:0) after 1m0s
[23:14:16.811] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:23:0)
[23:14:16.811] Timer tick, asking Buildbucket for the build status
[23:14:16.984] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:14:16.984] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:24:0) after 1m0s
[23:15:17.046] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:24:0)
[23:15:17.046] Timer tick, asking Buildbucket for the build status
[23:15:17.427] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:15:17.427] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:25:0) after 1m0s
[23:16:17.490] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:25:0)
[23:16:17.490] Timer tick, asking Buildbucket for the build status
[23:16:17.618] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:16:17.618] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:26:0) after 1m0s
[23:17:17.634] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:26:0)
[23:17:17.634] Timer tick, asking Buildbucket for the build status
[23:17:17.850] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:17:17.850] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:27:0) after 1m0s
[23:18:17.952] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:27:0)
[23:18:17.952] Timer tick, asking Buildbucket for the build status
[23:18:18.557] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:18:18.557] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:28:0) after 1m0s
[23:19:18.580] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:28:0)
[23:19:18.580] Timer tick, asking Buildbucket for the build status
[23:19:18.744] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:19:18.744] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:29:0) after 1m0s
[23:20:18.859] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:29:0)
[23:20:18.859] Timer tick, asking Buildbucket for the build status
[23:20:18.934] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:20:18.934] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:30:0) after 1m0s
[23:21:19.006] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:30:0)
[23:21:19.006] Timer tick, asking Buildbucket for the build status
[23:21:19.120] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:21:19.120] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:31:0) after 1m0s
[23:22:19.160] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:31:0)
[23:22:19.160] Timer tick, asking Buildbucket for the build status
[23:22:19.300] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:22:19.300] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:32:0) after 1m0s
[23:23:19.298] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:32:0)
[23:23:19.298] Timer tick, asking Buildbucket for the build status
[23:23:19.789] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:23:19.789] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:33:0) after 1m0s
[23:24:19.844] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:33:0)
[23:24:19.844] Timer tick, asking Buildbucket for the build status
[23:24:19.998] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:24:19.998] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:34:0) after 1m0s
[23:25:20.033] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:34:0)
[23:25:20.033] Timer tick, asking Buildbucket for the build status
[23:25:20.217] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:25:20.217] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:35:0) after 1m0s
[23:26:20.273] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:35:0)
[23:26:20.273] Timer tick, asking Buildbucket for the build status
[23:26:20.416] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:26:20.416] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:36:0) after 1m0s
[23:27:20.466] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:36:0)
[23:27:20.466] Timer tick, asking Buildbucket for the build status
[23:27:20.626] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:27:20.626] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:37:0) after 1m0s
[23:28:20.644] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:37:0)
[23:28:20.644] Timer tick, asking Buildbucket for the build status
[23:28:20.820] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:28:20.820] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:38:0) after 1m0s
[23:29:20.903] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:38:0)
[23:29:20.903] Timer tick, asking Buildbucket for the build status
[23:29:21.263] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:29:21.263] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:39:0) after 1m0s
[23:30:21.309] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:39:0)
[23:30:21.309] Timer tick, asking Buildbucket for the build status
[23:30:21.612] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:30:21.612] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:40:0) after 1m0s
[23:31:22.065] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:40:0)
[23:31:22.065] Timer tick, asking Buildbucket for the build status
[23:31:22.626] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:31:22.626] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:41:0) after 1m0s
[23:32:22.842] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:41:0)
[23:32:22.842] Timer tick, asking Buildbucket for the build status
[23:32:23.108] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:32:23.108] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:42:0) after 1m0s
[23:33:23.263] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:42:0)
[23:33:23.263] Timer tick, asking Buildbucket for the build status
[23:33:23.793] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:33:23.793] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:43:0) after 1m0s
[23:34:23.797] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:43:0)
[23:34:23.797] Timer tick, asking Buildbucket for the build status
[23:34:23.937] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:34:23.937] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:44:0) after 1m0s
[23:35:24.124] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:44:0)
[23:35:24.124] Timer tick, asking Buildbucket for the build status
[23:35:24.258] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:35:24.258] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:45:0) after 1m0s
[23:36:24.341] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:45:0)
[23:36:24.342] Timer tick, asking Buildbucket for the build status
[23:36:24.512] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:36:24.512] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:46:0) after 1m0s
[23:37:24.577] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:46:0)
[23:37:24.577] Timer tick, asking Buildbucket for the build status
[23:37:24.712] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:37:24.712] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:47:0) after 1m0s
[23:38:24.801] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:47:0)
[23:38:24.801] Timer tick, asking Buildbucket for the build status
[23:38:24.914] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:38:24.914] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:48:0) after 1m0s
[23:39:24.964] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:48:0)
[23:39:24.965] Timer tick, asking Buildbucket for the build status
[23:39:25.125] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:39:25.125] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:49:0) after 1m0s
[23:40:25.207] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:49:0)
[23:40:25.207] Timer tick, asking Buildbucket for the build status
[23:40:25.560] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:40:25.560] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:50:0) after 1m0s
[23:41:25.720] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:50:0)
[23:41:25.720] Timer tick, asking Buildbucket for the build status
[23:41:25.928] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:41:25.928] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:51:0) after 1m0s
[23:42:26.379] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:51:0)
[23:42:26.379] Timer tick, asking Buildbucket for the build status
[23:42:26.514] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:42:26.514] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:52:0) after 1m0s
[23:43:26.587] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:52:0)
[23:43:26.587] Timer tick, asking Buildbucket for the build status
[23:43:26.726] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:43:26.726] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:53:0) after 1m0s
[23:44:26.901] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:53:0)
[23:44:26.901] Timer tick, asking Buildbucket for the build status
[23:44:27.040] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:44:27.040] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:54:0) after 1m0s
[23:45:27.234] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:54:0)
[23:45:27.234] Timer tick, asking Buildbucket for the build status
[23:45:27.395] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:45:27.395] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:55:0) after 1m0s
[23:46:27.434] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:55:0)
[23:46:27.434] Timer tick, asking Buildbucket for the build status
[23:46:27.596] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:46:27.596] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:56:0) after 1m0s
[23:47:27.695] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:56:0)
[23:47:27.695] Timer tick, asking Buildbucket for the build status
[23:47:27.846] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:47:27.846] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:57:0) after 1m0s
[23:48:27.934] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:57:0)
[23:48:27.934] Timer tick, asking Buildbucket for the build status
[23:48:28.266] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:48:28.266] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:58:0) after 1m0s
[23:49:28.266] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:58:0)
[23:49:28.266] Timer tick, asking Buildbucket for the build status
[23:49:28.589] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:49:28.589] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:59:0) after 1m0s
[23:50:28.657] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:59:0)
[23:50:28.657] Timer tick, asking Buildbucket for the build status
[23:50:28.808] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:50:28.808] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:60:0) after 1m0s
[23:51:28.901] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:60:0)
[23:51:28.901] Timer tick, asking Buildbucket for the build status
[23:51:29.046] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:51:29.046] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:61:0) after 1m0s
[23:52:29.121] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:61:0)
[23:52:29.121] Timer tick, asking Buildbucket for the build status
[23:52:29.384] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:52:29.384] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:62:0) after 1m0s
[23:53:29.531] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:62:0)
[23:53:29.531] Timer tick, asking Buildbucket for the build status
[23:53:29.746] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:53:29.746] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:63:0) after 1m0s
[23:54:29.807] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:63:0)
[23:54:29.808] Timer tick, asking Buildbucket for the build status
[23:54:29.892] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:54:29.892] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:64:0) after 1m0s
[23:55:30.121] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:64:0)
[23:55:30.121] Timer tick, asking Buildbucket for the build status
[23:55:30.286] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:55:30.286] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:65:0) after 1m0s
[23:56:30.391] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:65:0)
[23:56:30.391] Timer tick, asking Buildbucket for the build status
[23:56:30.532] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:56:30.532] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:66:0) after 1m0s
[23:57:30.697] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:66:0)
[23:57:30.697] Timer tick, asking Buildbucket for the build status
[23:57:30.829] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:57:30.829] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:67:0) after 1m0s
[23:58:30.940] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:67:0)
[23:58:30.941] Timer tick, asking Buildbucket for the build status
[23:58:31.138] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:58:31.138] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:68:0) after 1m0s
[23:59:31.402] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:68:0)
[23:59:31.402] Timer tick, asking Buildbucket for the build status
[23:59:32.185] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:59:32.185] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:69:0) after 1m0s
[00:00:32.336] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:69:0)
[00:00:32.336] Timer tick, asking Buildbucket for the build status
[00:00:32.456] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:00:32.456] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:70:0) after 1m0s
[00:01:32.521] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:70:0)
[00:01:32.521] Timer tick, asking Buildbucket for the build status
[00:01:32.865] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:01:32.865] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:71:0) after 1m0s
[00:02:33.046] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:71:0)
[00:02:33.046] Timer tick, asking Buildbucket for the build status
[00:02:33.435] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:02:33.435] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:72:0) after 1m0s
[00:03:33.484] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:72:0)
[00:03:33.484] Timer tick, asking Buildbucket for the build status
[00:03:33.631] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:03:33.631] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:73:0) after 1m0s
[00:04:33.751] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:73:0)
[00:04:33.751] Timer tick, asking Buildbucket for the build status
[00:04:34.103] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:04:34.103] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:74:0) after 1m0s
[00:05:34.279] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:74:0)
[00:05:34.279] Timer tick, asking Buildbucket for the build status
[00:05:34.643] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:05:34.643] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:75:0) after 1m0s
[00:06:34.718] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:75:0)
[00:06:34.718] Timer tick, asking Buildbucket for the build status
[00:06:34.946] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:06:34.946] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:76:0) after 1m0s
[00:07:35.005] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:76:0)
[00:07:35.005] Timer tick, asking Buildbucket for the build status
[00:07:35.433] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:07:35.433] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:77:0) after 1m0s
[00:08:35.546] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:77:0)
[00:08:35.546] Timer tick, asking Buildbucket for the build status
[00:08:35.685] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:08:35.685] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:78:0) after 1m0s
[00:09:35.775] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:78:0)
[00:09:35.776] Timer tick, asking Buildbucket for the build status
[00:09:35.906] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:09:35.906] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:79:0) after 1m0s
[00:10:35.991] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:79:0)
[00:10:35.992] Timer tick, asking Buildbucket for the build status
[00:10:36.273] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:10:36.273] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:80:0) after 1m0s
[00:11:36.341] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:80:0)
[00:11:36.341] Timer tick, asking Buildbucket for the build status
[00:11:36.539] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:11:36.540] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:81:0) after 1m0s
[00:12:36.585] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:81:0)
[00:12:36.585] Timer tick, asking Buildbucket for the build status
[00:12:36.710] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:12:36.710] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:82:0) after 1m0s
[00:13:36.945] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:82:0)
[00:13:36.945] Timer tick, asking Buildbucket for the build status
[00:13:37.124] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:13:37.124] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:83:0) after 1m0s
[00:14:37.406] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:83:0)
[00:14:37.406] Timer tick, asking Buildbucket for the build status
[00:14:39.331] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:14:39.331] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:84:0) after 1m0s
[00:15:39.786] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:84:0)
[00:15:39.786] Timer tick, asking Buildbucket for the build status
[00:15:39.944] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:15:39.944] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:85:0) after 1m0s
[00:16:40.109] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:85:0)
[00:16:40.109] Timer tick, asking Buildbucket for the build status
[00:16:40.371] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:16:40.371] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:86:0) after 1m0s
[00:17:40.379] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:86:0)
[00:17:40.379] Timer tick, asking Buildbucket for the build status
[00:17:40.546] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:17:40.546] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:87:0) after 1m0s
[00:18:40.722] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:87:0)
[00:18:40.722] Timer tick, asking Buildbucket for the build status
[00:18:40.876] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:18:40.876] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:88:0) after 1m0s
[00:19:41.005] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:88:0)
[00:19:41.005] Timer tick, asking Buildbucket for the build status
[00:19:41.135] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:19:41.135] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:89:0) after 1m0s
[00:20:41.182] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:89:0)
[00:20:41.182] Timer tick, asking Buildbucket for the build status
[00:20:41.342] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:20:41.342] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:90:0) after 1m0s
[00:21:41.577] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:90:0)
[00:21:41.577] Timer tick, asking Buildbucket for the build status
[00:21:41.711] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:21:41.711] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:91:0) after 1m0s
[00:22:41.884] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:91:0)
[00:22:41.884] Timer tick, asking Buildbucket for the build status
[00:22:42.023] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:22:42.023] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:92:0) after 1m0s
[00:23:42.139] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:92:0)
[00:23:42.139] Timer tick, asking Buildbucket for the build status
[00:23:42.444] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:23:42.444] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:93:0) after 1m0s
[00:24:42.627] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:93:0)
[00:24:42.627] Timer tick, asking Buildbucket for the build status
[00:24:42.734] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:24:42.734] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:94:0) after 1m0s
[00:25:42.943] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:94:0)
[00:25:42.943] Timer tick, asking Buildbucket for the build status
[00:25:43.071] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:25:43.071] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:95:0) after 1m0s
[00:26:43.122] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:95:0)
[00:26:43.122] Timer tick, asking Buildbucket for the build status
[00:26:43.391] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:26:43.391] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:96:0) after 1m0s
[00:27:43.439] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:96:0)
[00:27:43.439] Timer tick, asking Buildbucket for the build status
[00:27:44.825] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:27:44.825] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:97:0) after 1m0s
[00:28:44.900] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:97:0)
[00:28:44.900] Timer tick, asking Buildbucket for the build status
[00:28:45.088] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:28:45.088] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:98:0) after 1m0s
[00:29:45.262] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:98:0)
[00:29:45.262] Timer tick, asking Buildbucket for the build status
[00:29:45.405] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:29:45.405] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:99:0) after 1m0s
[00:30:45.543] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:99:0)
[00:30:45.543] Timer tick, asking Buildbucket for the build status
[00:30:45.938] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:30:45.938] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:100:0) after 1m0s
[00:31:45.960] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:100:0)
[00:31:45.960] Timer tick, asking Buildbucket for the build status
[00:31:46.634] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:31:46.634] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:101:0) after 1m0s
[00:32:46.736] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:101:0)
[00:32:46.736] Timer tick, asking Buildbucket for the build status
[00:32:46.976] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:32:46.976] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:102:0) after 1m0s
[00:33:47.033] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:102:0)
[00:33:47.034] Timer tick, asking Buildbucket for the build status
[00:33:47.218] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:33:47.218] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:103:0) after 1m0s
[00:34:47.341] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:103:0)
[00:34:47.341] Timer tick, asking Buildbucket for the build status
[00:34:47.754] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:34:47.754] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:104:0) after 1m0s
[00:35:47.777] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:104:0)
[00:35:47.777] Timer tick, asking Buildbucket for the build status
[00:35:48.194] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:35:48.194] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:105:0) after 1m0s
[00:36:48.274] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:105:0)
[00:36:48.274] Timer tick, asking Buildbucket for the build status
[00:36:48.353] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:36:48.353] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:106:0) after 1m0s
[00:37:48.543] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:106:0)
[00:37:48.543] Timer tick, asking Buildbucket for the build status
[00:37:48.691] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:37:48.691] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:107:0) after 1m0s
[00:38:48.791] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:107:0)
[00:38:48.791] Timer tick, asking Buildbucket for the build status
[00:38:48.928] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:38:48.928] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:108:0) after 1m0s
[00:39:48.951] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:108:0)
[00:39:48.951] Timer tick, asking Buildbucket for the build status
[00:39:49.164] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:39:49.164] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:109:0) after 1m0s
[00:40:49.160] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:109:0)
[00:40:49.160] Timer tick, asking Buildbucket for the build status
[00:40:49.294] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:40:49.294] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:110:0) after 1m0s
[00:41:49.324] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:110:0)
[00:41:49.324] Timer tick, asking Buildbucket for the build status
[00:41:49.610] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:41:49.610] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:111:0) after 1m0s
[00:42:49.665] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:111:0)
[00:42:49.665] Timer tick, asking Buildbucket for the build status
[00:42:49.774] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:42:49.774] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:112:0) after 1m0s
[00:43:49.850] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:112:0)
[00:43:49.850] Timer tick, asking Buildbucket for the build status
[00:43:50.002] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:43:50.002] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:113:0) after 1m0s
[00:44:50.062] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:113:0)
[00:44:50.062] Timer tick, asking Buildbucket for the build status
[00:44:50.554] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:44:50.554] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:114:0) after 1m0s
[00:45:50.644] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:114:0)
[00:45:50.644] Timer tick, asking Buildbucket for the build status
[00:45:50.798] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:45:50.798] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:115:0) after 1m0s
[00:46:50.855] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:115:0)
[00:46:50.855] Timer tick, asking Buildbucket for the build status
[00:46:51.036] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:46:51.036] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:116:0) after 1m0s
[00:47:51.142] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:116:0)
[00:47:51.142] Timer tick, asking Buildbucket for the build status
[00:47:51.468] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:47:51.469] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:117:0) after 1m0s
[00:48:51.495] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:117:0)
[00:48:51.495] Timer tick, asking Buildbucket for the build status
[00:48:51.666] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:48:51.666] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:118:0) after 1m0s
[00:49:51.781] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:118:0)
[00:49:51.781] Timer tick, asking Buildbucket for the build status
[00:49:51.960] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:49:51.960] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:119:0) after 1m0s
[00:50:52.071] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:119:0)
[00:50:52.071] Timer tick, asking Buildbucket for the build status
[00:50:52.202] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:50:52.202] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:120:0) after 1m0s
[00:51:52.296] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:120:0)
[00:51:52.296] Timer tick, asking Buildbucket for the build status
[00:51:52.455] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:51:52.455] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:121:0) after 1m0s
[00:52:52.478] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:121:0)
[00:52:52.478] Timer tick, asking Buildbucket for the build status
[00:52:52.687] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:52:52.687] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:122:0) after 1m0s
[00:53:52.686] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:122:0)
[00:53:52.686] Timer tick, asking Buildbucket for the build status
[00:53:53.197] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:53:53.197] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:123:0) after 1m0s
[00:54:53.255] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:123:0)
[00:54:53.255] Timer tick, asking Buildbucket for the build status
[00:54:53.760] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:54:53.760] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:124:0) after 1m0s
[00:55:53.850] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:124:0)
[00:55:53.850] Timer tick, asking Buildbucket for the build status
[00:55:54.230] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:55:54.230] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:125:0) after 1m0s
[00:56:54.333] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:125:0)
[00:56:54.333] Timer tick, asking Buildbucket for the build status
[00:56:54.482] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:56:54.482] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:126:0) after 1m0s
[00:57:54.597] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:126:0)
[00:57:54.597] Timer tick, asking Buildbucket for the build status
[00:57:54.737] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:57:54.737] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:127:0) after 1m0s
[00:58:54.969] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:127:0)
[00:58:54.969] Timer tick, asking Buildbucket for the build status
[00:58:55.082] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:58:55.082] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:128:0) after 1m0s
[00:59:55.150] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:128:0)
[00:59:55.150] Timer tick, asking Buildbucket for the build status
[00:59:55.831] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:59:55.831] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:129:0) after 1m0s
[01:00:55.928] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:129:0)
[01:00:55.928] Timer tick, asking Buildbucket for the build status
[01:00:56.106] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:00:56.106] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:130:0) after 1m0s
[01:01:56.214] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:130:0)
[01:01:56.214] Timer tick, asking Buildbucket for the build status
[01:01:57.056] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:01:57.056] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:131:0) after 1m0s
[01:02:57.172] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:131:0)
[01:02:57.172] Timer tick, asking Buildbucket for the build status
[01:02:57.424] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:02:57.424] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:132:0) after 1m0s
[01:03:57.447] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:132:0)
[01:03:57.447] Timer tick, asking Buildbucket for the build status
[01:03:57.583] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:03:57.583] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:133:0) after 1m0s
[01:04:57.626] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:133:0)
[01:04:57.626] Timer tick, asking Buildbucket for the build status
[01:04:57.796] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:04:57.796] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:134:0) after 1m0s
[01:05:57.837] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:134:0)
[01:05:57.837] Timer tick, asking Buildbucket for the build status
[01:05:57.954] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:05:57.954] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:135:0) after 1m0s
[01:06:58.150] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:135:0)
[01:06:58.150] Timer tick, asking Buildbucket for the build status
[01:06:58.399] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:06:58.399] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:136:0) after 1m0s
[01:07:58.609] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:136:0)
[01:07:58.609] Timer tick, asking Buildbucket for the build status
[01:07:59.077] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:07:59.077] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:137:0) after 1m0s
[01:08:59.103] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:137:0)
[01:08:59.103] Timer tick, asking Buildbucket for the build status
[01:09:00.134] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:09:00.134] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:138:0) after 1m0s
[01:10:00.174] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:138:0)
[01:10:00.174] Timer tick, asking Buildbucket for the build status
[01:10:00.608] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:10:00.608] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:139:0) after 1m0s
[01:11:00.632] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:139:0)
[01:11:00.632] Timer tick, asking Buildbucket for the build status
[01:11:00.806] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:11:00.806] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:140:0) after 1m0s
[01:12:00.831] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:140:0)
[01:12:00.831] Timer tick, asking Buildbucket for the build status
[01:12:00.956] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:12:00.956] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:141:0) after 1m0s
[01:13:01.012] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:141:0)
[01:13:01.012] Timer tick, asking Buildbucket for the build status
[01:13:01.133] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:13:01.133] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:142:0) after 1m0s
[01:14:01.138] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:142:0)
[01:14:01.138] Timer tick, asking Buildbucket for the build status
[01:14:01.451] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:14:01.451] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:143:0) after 1m0s
[01:15:01.650] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:143:0)
[01:15:01.650] Timer tick, asking Buildbucket for the build status
[01:15:01.953] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:15:01.953] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:144:0) after 1m0s
[01:16:01.982] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:144:0)
[01:16:01.982] Timer tick, asking Buildbucket for the build status
[01:16:02.151] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:16:02.151] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:145:0) after 1m0s
[01:17:02.163] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:145:0)
[01:17:02.163] Timer tick, asking Buildbucket for the build status
[01:17:02.452] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:17:02.452] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:146:0) after 1m0s
[01:18:02.562] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:146:0)
[01:18:02.562] Timer tick, asking Buildbucket for the build status
[01:18:02.771] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:18:02.771] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:147:0) after 1m0s
[01:19:02.849] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:147:0)
[01:19:02.849] Timer tick, asking Buildbucket for the build status
[01:19:02.997] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:19:02.997] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:148:0) after 1m0s
[01:20:03.002] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:148:0)
[01:20:03.002] Timer tick, asking Buildbucket for the build status
[01:20:03.240] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:20:03.240] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:149:0) after 1m0s
[01:21:03.284] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:149:0)
[01:21:03.284] Timer tick, asking Buildbucket for the build status
[01:21:03.568] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:21:03.568] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:150:0) after 1m0s
[01:22:03.589] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:150:0)
[01:22:03.589] Timer tick, asking Buildbucket for the build status
[01:22:04.299] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:22:04.299] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:151:0) after 1m0s
[01:23:04.511] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:151:0)
[01:23:04.511] Timer tick, asking Buildbucket for the build status
[01:23:04.795] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:23:04.795] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:152:0) after 1m0s
[01:24:04.898] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:152:0)
[01:24:04.898] Timer tick, asking Buildbucket for the build status
[01:24:06.540] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:24:06.540] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:153:0) after 1m0s
[01:25:06.610] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:153:0)
[01:25:06.610] Timer tick, asking Buildbucket for the build status
[01:25:07.259] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:25:07.259] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:154:0) after 1m0s
[01:26:07.467] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:154:0)
[01:26:07.467] Timer tick, asking Buildbucket for the build status
[01:26:07.653] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:26:07.653] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:155:0) after 1m0s
[01:27:07.760] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:155:0)
[01:27:07.760] Timer tick, asking Buildbucket for the build status
[01:27:07.958] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:27:07.958] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:156:0) after 1m0s
[01:28:08.027] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:156:0)
[01:28:08.027] Timer tick, asking Buildbucket for the build status
[01:28:08.392] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:28:08.392] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:157:0) after 1m0s
[01:29:08.562] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:157:0)
[01:29:08.562] Timer tick, asking Buildbucket for the build status
[01:29:09.035] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:29:09.035] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:158:0) after 1m0s
[01:30:09.147] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:158:0)
[01:30:09.147] Timer tick, asking Buildbucket for the build status
[01:30:10.277] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:30:10.278] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:159:0) after 1m0s
[01:31:10.346] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:159:0)
[01:31:10.346] Timer tick, asking Buildbucket for the build status
[01:31:12.095] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:31:12.095] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:160:0) after 1m0s
[01:32:12.138] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:160:0)
[01:32:12.138] Timer tick, asking Buildbucket for the build status
[01:32:12.262] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:32:12.262] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:161:0) after 1m0s
[01:33:12.264] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:161:0)
[01:33:12.265] Timer tick, asking Buildbucket for the build status
[01:33:12.555] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:33:12.555] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:162:0) after 1m0s
[01:34:12.633] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:162:0)
[01:34:12.633] Timer tick, asking Buildbucket for the build status
[01:34:14.979] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:34:14.979] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:163:0) after 1m0s
[01:35:14.981] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:163:0)
[01:35:14.981] Timer tick, asking Buildbucket for the build status
[01:35:15.263] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:35:15.263] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:164:0) after 1m0s
[01:36:15.298] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:164:0)
[01:36:15.298] Timer tick, asking Buildbucket for the build status
[01:36:15.800] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:36:15.800] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:165:0) after 1m0s
[01:37:15.914] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:165:0)
[01:37:15.914] Timer tick, asking Buildbucket for the build status
[01:37:16.731] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:37:16.731] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:166:0) after 1m0s
[01:38:16.796] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:166:0)
[01:38:16.797] Timer tick, asking Buildbucket for the build status
[01:38:16.918] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:38:16.918] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:167:0) after 1m0s
[01:39:16.953] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:167:0)
[01:39:16.953] Timer tick, asking Buildbucket for the build status
[01:39:17.172] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:39:17.172] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:168:0) after 1m0s
[01:40:17.206] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:168:0)
[01:40:17.206] Timer tick, asking Buildbucket for the build status
[01:40:17.521] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:40:17.521] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:169:0) after 1m0s
[01:41:17.515] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:169:0)
[01:41:17.515] Timer tick, asking Buildbucket for the build status
[01:41:18.153] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:41:18.153] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:170:0) after 1m0s
[01:42:18.213] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:170:0)
[01:42:18.213] Timer tick, asking Buildbucket for the build status
[01:42:18.724] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:42:18.724] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:171:0) after 1m0s
[01:43:18.835] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:171:0)
[01:43:18.835] Timer tick, asking Buildbucket for the build status
[01:43:19.018] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:43:19.018] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:172:0) after 1m0s
[01:44:19.083] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:172:0)
[01:44:19.083] Timer tick, asking Buildbucket for the build status
[01:44:19.146] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:44:19.146] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:173:0) after 1m0s
[01:45:19.186] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:173:0)
[01:45:19.186] Timer tick, asking Buildbucket for the build status
[01:45:19.321] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:45:19.321] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:174:0) after 1m0s
[01:46:19.474] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:174:0)
[01:46:19.474] Timer tick, asking Buildbucket for the build status
[01:46:19.708] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:46:19.708] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:175:0) after 1m0s
[01:47:19.736] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:175:0)
[01:47:19.736] Timer tick, asking Buildbucket for the build status
[01:47:20.116] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:47:20.116] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:176:0) after 1m0s
[01:48:20.245] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:176:0)
[01:48:20.245] Timer tick, asking Buildbucket for the build status
[01:48:20.389] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:48:20.389] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:177:0) after 1m0s
[01:49:20.585] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:177:0)
[01:49:20.585] Timer tick, asking Buildbucket for the build status
[01:49:20.955] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:49:20.955] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:178:0) after 1m0s
[01:50:21.002] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:178:0)
[01:50:21.003] Timer tick, asking Buildbucket for the build status
[01:50:21.384] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:50:21.384] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:179:0) after 1m0s
[01:51:21.419] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:179:0)
[01:51:21.419] Timer tick, asking Buildbucket for the build status
[01:51:21.650] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:51:21.650] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:180:0) after 1m0s
[01:52:21.680] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:180:0)
[01:52:21.680] Timer tick, asking Buildbucket for the build status
[01:52:22.275] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:52:22.275] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:181:0) after 1m0s
[01:53:22.408] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:181:0)
[01:53:22.408] Timer tick, asking Buildbucket for the build status
[01:53:22.542] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:53:22.542] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:182:0) after 1m0s
[01:54:22.596] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:182:0)
[01:54:22.596] Timer tick, asking Buildbucket for the build status
[01:54:22.796] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:54:22.796] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:183:0) after 1m0s
[01:55:22.861] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:183:0)
[01:55:22.861] Timer tick, asking Buildbucket for the build status
[01:55:23.179] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:55:23.179] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:184:0) after 1m0s
[01:56:23.274] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:184:0)
[01:56:23.274] Timer tick, asking Buildbucket for the build status
[01:56:23.387] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:56:23.387] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:185:0) after 1m0s
[01:57:23.407] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:185:0)
[01:57:23.407] Timer tick, asking Buildbucket for the build status
[01:57:23.626] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:57:23.626] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:186:0) after 1m0s
[01:58:23.611] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:186:0)
[01:58:23.611] Timer tick, asking Buildbucket for the build status
[01:58:23.686] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:58:23.686] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:187:0) after 1m0s
[01:59:23.778] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:187:0)
[01:59:23.778] Timer tick, asking Buildbucket for the build status
[01:59:24.265] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:59:24.265] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:188:0) after 1m0s
[02:00:24.324] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:188:0)
[02:00:24.324] Timer tick, asking Buildbucket for the build status
[02:00:24.583] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:00:24.583] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:189:0) after 1m0s
[02:01:24.751] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:189:0)
[02:01:24.751] Timer tick, asking Buildbucket for the build status
[02:01:24.931] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:01:24.931] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:190:0) after 1m0s
[02:02:25.064] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:190:0)
[02:02:25.064] Timer tick, asking Buildbucket for the build status
[02:02:25.192] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:02:25.192] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:191:0) after 1m0s
[02:03:25.221] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:191:0)
[02:03:25.221] Timer tick, asking Buildbucket for the build status
[02:03:25.347] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:03:25.347] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:192:0) after 1m0s
[02:04:25.417] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:192:0)
[02:04:25.417] Timer tick, asking Buildbucket for the build status
[02:04:26.143] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:04:26.143] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:193:0) after 1m0s
[02:05:26.285] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:193:0)
[02:05:26.285] Timer tick, asking Buildbucket for the build status
[02:05:26.422] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:05:26.422] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:194:0) after 1m0s
[02:06:26.443] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:194:0)
[02:06:26.443] Timer tick, asking Buildbucket for the build status
[02:06:26.699] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:06:26.699] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:195:0) after 1m0s
[02:07:26.829] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:195:0)
[02:07:26.830] Timer tick, asking Buildbucket for the build status
[02:07:27.003] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:07:27.003] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:196:0) after 1m0s
[02:08:27.099] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:196:0)
[02:08:27.099] Timer tick, asking Buildbucket for the build status
[02:08:27.453] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:08:27.453] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:197:0) after 1m0s
[02:09:27.516] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:197:0)
[02:09:27.516] Timer tick, asking Buildbucket for the build status
[02:09:27.617] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:09:27.617] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:198:0) after 1m0s
[02:10:27.645] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:198:0)
[02:10:27.645] Timer tick, asking Buildbucket for the build status
[02:10:27.795] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:10:27.795] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:199:0) after 1m0s
[02:11:27.825] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:199:0)
[02:11:27.825] Timer tick, asking Buildbucket for the build status
[02:11:28.078] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:11:28.078] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:200:0) after 1m0s
[02:12:28.108] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:200:0)
[02:12:28.108] Timer tick, asking Buildbucket for the build status
[02:12:28.263] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:12:28.263] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:201:0) after 1m0s
[02:13:28.338] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:201:0)
[02:13:28.338] Timer tick, asking Buildbucket for the build status
[02:13:28.505] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:13:28.505] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:202:0) after 1m0s
[02:14:28.578] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:202:0)
[02:14:28.578] Timer tick, asking Buildbucket for the build status
[02:14:29.083] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:14:29.083] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:203:0) after 1m0s
[02:15:29.197] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:203:0)
[02:15:29.197] Timer tick, asking Buildbucket for the build status
[02:15:29.654] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:15:29.654] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:204:0) after 1m0s
[02:16:29.713] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:204:0)
[02:16:29.713] Timer tick, asking Buildbucket for the build status
[02:16:30.026] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:16:30.026] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:205:0) after 1m0s
[02:17:30.169] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:205:0)
[02:17:30.169] Timer tick, asking Buildbucket for the build status
[02:17:30.333] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:17:30.333] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:206:0) after 1m0s
[02:18:30.360] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:206:0)
[02:18:30.360] Timer tick, asking Buildbucket for the build status
[02:18:30.623] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:18:30.623] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:207:0) after 1m0s
[02:19:30.629] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:207:0)
[02:19:30.629] Timer tick, asking Buildbucket for the build status
[02:19:30.815] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:19:30.815] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:208:0) after 1m0s
[02:20:30.972] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:208:0)
[02:20:30.972] Timer tick, asking Buildbucket for the build status
[02:20:31.082] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:20:31.082] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:209:0) after 1m0s
[02:21:31.240] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:209:0)
[02:21:31.240] Timer tick, asking Buildbucket for the build status
[02:21:31.515] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:21:31.515] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:210:0) after 1m0s
[02:22:31.553] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:210:0)
[02:22:31.553] Timer tick, asking Buildbucket for the build status
[02:22:31.656] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:22:31.656] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:211:0) after 1m0s
[02:23:31.739] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:211:0)
[02:23:31.739] Timer tick, asking Buildbucket for the build status
[02:23:32.088] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:23:32.088] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:212:0) after 1m0s
[02:24:32.266] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:212:0)
[02:24:32.266] Timer tick, asking Buildbucket for the build status
[02:24:35.764] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:24:35.765] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:213:0) after 1m0s
[02:25:35.957] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:213:0)
[02:25:35.957] Timer tick, asking Buildbucket for the build status
[02:25:36.120] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:25:36.120] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:214:0) after 1m0s
[02:26:36.277] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:214:0)
[02:26:36.277] Timer tick, asking Buildbucket for the build status
[02:26:36.482] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:26:36.482] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:215:0) after 1m0s
[02:27:36.733] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:215:0)
[02:27:36.733] Timer tick, asking Buildbucket for the build status
[02:27:36.989] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:27:36.989] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:216:0) after 1m0s
[02:28:37.107] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:216:0)
[02:28:37.107] Timer tick, asking Buildbucket for the build status
[02:28:37.215] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:28:37.215] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:217:0) after 1m0s
[02:29:37.269] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:217:0)
[02:29:37.269] Timer tick, asking Buildbucket for the build status
[02:29:37.416] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:29:37.416] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:218:0) after 1m0s
[02:30:37.481] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:218:0)
[02:30:37.481] Timer tick, asking Buildbucket for the build status
[02:30:37.627] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:30:37.627] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:219:0) after 1m0s
[02:31:37.639] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:219:0)
[02:31:37.639] Timer tick, asking Buildbucket for the build status
[02:31:37.817] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:31:37.817] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:220:0) after 1m0s
[02:32:37.891] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:220:0)
[02:32:37.891] Timer tick, asking Buildbucket for the build status
[02:32:38.110] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:32:38.110] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:221:0) after 1m0s
[02:33:38.162] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:221:0)
[02:33:38.162] Timer tick, asking Buildbucket for the build status
[02:33:38.525] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:33:38.525] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:222:0) after 1m0s
[02:34:38.569] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:222:0)
[02:34:38.569] Timer tick, asking Buildbucket for the build status
[02:34:38.685] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:34:38.685] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:223:0) after 1m0s
[02:35:38.827] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:223:0)
[02:35:38.827] Timer tick, asking Buildbucket for the build status
[02:35:39.073] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:35:39.073] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:224:0) after 1m0s
[02:36:39.255] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:224:0)
[02:36:39.255] Timer tick, asking Buildbucket for the build status
[02:36:39.417] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:36:39.417] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:225:0) after 1m0s
[02:37:39.505] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:225:0)
[02:37:39.505] Timer tick, asking Buildbucket for the build status
[02:37:39.861] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:37:39.861] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:226:0) after 1m0s
[02:38:39.961] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:226:0)
[02:38:39.961] Timer tick, asking Buildbucket for the build status
[02:38:40.295] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:38:40.295] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:227:0) after 1m0s
[02:39:40.384] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:227:0)
[02:39:40.384] Timer tick, asking Buildbucket for the build status
[02:39:40.513] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:39:40.513] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:228:0) after 1m0s
[02:40:40.688] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:228:0)
[02:40:40.688] Timer tick, asking Buildbucket for the build status
[02:40:41.012] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:40:41.012] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:229:0) after 1m0s
[02:41:41.134] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:229:0)
[02:41:41.134] Timer tick, asking Buildbucket for the build status
[02:41:41.468] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:41:41.468] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:230:0) after 1m0s
[02:42:41.589] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:230:0)
[02:42:41.589] Timer tick, asking Buildbucket for the build status
[02:42:41.759] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:42:41.759] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:231:0) after 1m0s
[02:43:41.878] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:231:0)
[02:43:41.878] Timer tick, asking Buildbucket for the build status
[02:43:42.329] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:43:42.329] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:232:0) after 1m0s
[02:44:42.403] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:232:0)
[02:44:42.403] Timer tick, asking Buildbucket for the build status
[02:44:42.598] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:44:42.599] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:233:0) after 1m0s
[02:45:42.695] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:233:0)
[02:45:42.695] Timer tick, asking Buildbucket for the build status
[02:45:42.852] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:45:42.852] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:234:0) after 1m0s
[02:46:42.915] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:234:0)
[02:46:42.915] Timer tick, asking Buildbucket for the build status
[02:46:43.062] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:46:43.062] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:235:0) after 1m0s
[02:47:43.183] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:235:0)
[02:47:43.183] Timer tick, asking Buildbucket for the build status
[02:47:43.338] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:47:43.338] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:236:0) after 1m0s
[02:48:43.383] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:236:0)
[02:48:43.383] Timer tick, asking Buildbucket for the build status
[02:48:43.580] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:48:43.580] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:237:0) after 1m0s
[02:49:43.668] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:237:0)
[02:49:43.668] Timer tick, asking Buildbucket for the build status
[02:49:44.131] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:49:44.131] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:238:0) after 1m0s
[02:50:44.189] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:238:0)
[02:50:44.189] Timer tick, asking Buildbucket for the build status
[02:50:44.354] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:50:44.354] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:239:0) after 1m0s
[02:51:44.381] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:239:0)
[02:51:44.381] Timer tick, asking Buildbucket for the build status
[02:51:44.690] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:51:44.690] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:240:0) after 1m0s
[02:52:44.759] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:240:0)
[02:52:44.759] Timer tick, asking Buildbucket for the build status
[02:52:45.269] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:52:45.269] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:241:0) after 1m0s
[02:53:45.300] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:241:0)
[02:53:45.300] Timer tick, asking Buildbucket for the build status
[02:53:45.381] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:53:45.381] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:242:0) after 1m0s
[02:54:45.452] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:242:0)
[02:54:45.452] Timer tick, asking Buildbucket for the build status
[02:54:46.008] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:54:46.008] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:243:0) after 1m0s
[02:55:46.211] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:243:0)
[02:55:46.211] Timer tick, asking Buildbucket for the build status
[02:55:46.374] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:55:46.374] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:244:0) after 1m0s
[02:56:46.490] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:244:0)
[02:56:46.490] Timer tick, asking Buildbucket for the build status
[02:56:46.618] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:56:46.618] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:245:0) after 1m0s
[02:57:46.742] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:245:0)
[02:57:46.742] Timer tick, asking Buildbucket for the build status
[02:57:47.145] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:57:47.145] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:246:0) after 1m0s
[02:58:47.210] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:246:0)
[02:58:47.210] Timer tick, asking Buildbucket for the build status
[02:58:47.372] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:58:47.372] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:247:0) after 1m0s
[02:59:47.400] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:247:0)
[02:59:47.400] Timer tick, asking Buildbucket for the build status
[02:59:47.578] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:59:47.578] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:248:0) after 1m0s
[03:00:47.611] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:248:0)
[03:00:47.611] Timer tick, asking Buildbucket for the build status
[03:00:47.836] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:00:47.836] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:249:0) after 1m0s
[03:01:47.869] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:249:0)
[03:01:47.869] Timer tick, asking Buildbucket for the build status
[03:01:48.109] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:01:48.109] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:250:0) after 1m0s
[03:02:48.138] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:250:0)
[03:02:48.138] Timer tick, asking Buildbucket for the build status
[03:02:48.274] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:02:48.274] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:251:0) after 1m0s
[03:03:48.317] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:251:0)
[03:03:48.318] Timer tick, asking Buildbucket for the build status
[03:03:48.505] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:03:48.505] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:252:0) after 1m0s
[03:04:48.683] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:252:0)
[03:04:48.683] Timer tick, asking Buildbucket for the build status
[03:04:48.803] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:04:48.803] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:253:0) after 1m0s
[03:05:49.008] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:253:0)
[03:05:49.009] Timer tick, asking Buildbucket for the build status
[03:05:49.264] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:05:49.264] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:254:0) after 1m0s
[03:06:49.376] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:254:0)
[03:06:49.376] Timer tick, asking Buildbucket for the build status
[03:06:49.532] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:06:49.533] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:255:0) after 1m0s
[03:07:49.605] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:255:0)
[03:07:49.605] Timer tick, asking Buildbucket for the build status
[03:07:50.366] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:07:50.366] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:256:0) after 1m0s
[03:08:51.338] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:256:0)
[03:08:51.338] Timer tick, asking Buildbucket for the build status
[03:08:51.504] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:08:51.504] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:257:0) after 1m0s
[03:09:51.578] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:257:0)
[03:09:51.578] Timer tick, asking Buildbucket for the build status
[03:09:52.153] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:09:52.153] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:258:0) after 1m0s
[03:10:52.288] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:258:0)
[03:10:52.288] Timer tick, asking Buildbucket for the build status
[03:10:52.594] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:10:52.594] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:259:0) after 1m0s
[03:11:52.623] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:259:0)
[03:11:52.623] Timer tick, asking Buildbucket for the build status
[03:11:52.974] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:11:52.974] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:260:0) after 1m0s
[03:12:53.074] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:260:0)
[03:12:53.074] Timer tick, asking Buildbucket for the build status
[03:12:53.224] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:12:53.224] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:261:0) after 1m0s
[03:13:53.292] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:261:0)
[03:13:53.292] Timer tick, asking Buildbucket for the build status
[03:13:53.452] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:13:53.452] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:262:0) after 1m0s
[03:14:53.460] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:262:0)
[03:14:53.460] Timer tick, asking Buildbucket for the build status
[03:14:53.895] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:14:53.895] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:263:0) after 1m0s
[03:15:53.965] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:263:0)
[03:15:53.965] Timer tick, asking Buildbucket for the build status
[03:15:54.099] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:15:54.099] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:264:0) after 1m0s
[03:16:54.169] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:264:0)
[03:16:54.169] Timer tick, asking Buildbucket for the build status
[03:16:54.301] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:16:54.301] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:265:0) after 1m0s
[03:17:54.377] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:265:0)
[03:17:54.377] Timer tick, asking Buildbucket for the build status
[03:17:54.595] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:17:54.595] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:266:0) after 1m0s
[03:18:54.709] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:266:0)
[03:18:54.709] Timer tick, asking Buildbucket for the build status
[03:18:54.796] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:18:54.796] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:267:0) after 1m0s
[03:19:54.876] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:267:0)
[03:19:54.876] Timer tick, asking Buildbucket for the build status
[03:19:55.448] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:19:55.448] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:268:0) after 1m0s
[03:20:55.609] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:268:0)
[03:20:55.609] Timer tick, asking Buildbucket for the build status
[03:20:55.814] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:20:55.814] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:269:0) after 1m0s
[03:21:55.967] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:269:0)
[03:21:55.967] Timer tick, asking Buildbucket for the build status
[03:21:56.109] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:21:56.109] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:270:0) after 1m0s
[03:22:56.146] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:270:0)
[03:22:56.146] Timer tick, asking Buildbucket for the build status
[03:22:56.583] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:22:56.583] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:271:0) after 1m0s
[03:23:56.630] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:271:0)
[03:23:56.630] Timer tick, asking Buildbucket for the build status
[03:23:56.820] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:23:56.820] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:272:0) after 1m0s
[03:24:56.893] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:272:0)
[03:24:56.893] Timer tick, asking Buildbucket for the build status
[03:24:57.054] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:24:57.054] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:273:0) after 1m0s
[03:25:57.117] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:273:0)
[03:25:57.117] Timer tick, asking Buildbucket for the build status
[03:25:57.369] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:25:57.369] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:274:0) after 1m0s
[03:26:57.611] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:274:0)
[03:26:57.611] Timer tick, asking Buildbucket for the build status
[03:26:57.771] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:26:57.771] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:275:0) after 1m0s
[03:27:58.059] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:275:0)
[03:27:58.059] Timer tick, asking Buildbucket for the build status
[03:27:59.459] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:27:59.459] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:276:0) after 1m0s
[03:28:59.573] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:276:0)
[03:28:59.573] Timer tick, asking Buildbucket for the build status
[03:28:59.667] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:28:59.667] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:277:0) after 1m0s
[03:29:59.737] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:277:0)
[03:29:59.737] Timer tick, asking Buildbucket for the build status
[03:30:00.098] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:30:00.098] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:278:0) after 1m0s
[03:31:00.131] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:278:0)
[03:31:00.131] Timer tick, asking Buildbucket for the build status
[03:31:00.305] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:31:00.305] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:279:0) after 1m0s
[03:32:00.430] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:279:0)
[03:32:00.430] Timer tick, asking Buildbucket for the build status
[03:32:01.657] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:32:01.657] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:280:0) after 1m0s
[03:33:01.670] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:280:0)
[03:33:01.670] Timer tick, asking Buildbucket for the build status
[03:33:01.848] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:33:01.848] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:281:0) after 1m0s
[03:34:01.979] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:281:0)
[03:34:01.979] Timer tick, asking Buildbucket for the build status
[03:34:02.348] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:34:02.348] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:282:0) after 1m0s
[03:35:02.376] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:282:0)
[03:35:02.376] Timer tick, asking Buildbucket for the build status
[03:35:02.678] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:35:02.678] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:283:0) after 1m0s
[03:36:02.795] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:283:0)
[03:36:02.796] Timer tick, asking Buildbucket for the build status
[03:36:03.258] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:36:03.258] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:284:0) after 1m0s
[03:37:03.421] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:284:0)
[03:37:03.421] Timer tick, asking Buildbucket for the build status
[03:37:05.494] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:37:05.494] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:285:0) after 1m0s
[03:38:05.563] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:285:0)
[03:38:05.563] Timer tick, asking Buildbucket for the build status
[03:38:05.669] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:38:05.670] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:286:0) after 1m0s
[03:39:05.702] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:286:0)
[03:39:05.702] Timer tick, asking Buildbucket for the build status
[03:39:05.834] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:39:05.834] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:287:0) after 1m0s
[03:40:06.104] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:287:0)
[03:40:06.104] Timer tick, asking Buildbucket for the build status
[03:40:06.308] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:40:06.308] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:288:0) after 1m0s
[03:41:06.376] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:288:0)
[03:41:06.376] Timer tick, asking Buildbucket for the build status
[03:41:06.490] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:41:06.491] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:289:0) after 1m0s
[03:42:06.539] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:289:0)
[03:42:06.539] Timer tick, asking Buildbucket for the build status
[03:42:06.808] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:42:06.808] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:290:0) after 1m0s
[03:43:06.946] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:290:0)
[03:43:06.946] Timer tick, asking Buildbucket for the build status
[03:43:07.126] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:43:07.126] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:291:0) after 1m0s
[03:44:07.280] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:291:0)
[03:44:07.280] Timer tick, asking Buildbucket for the build status
[03:44:07.715] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:44:07.715] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:292:0) after 1m0s
[03:45:07.757] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:292:0)
[03:45:07.757] Timer tick, asking Buildbucket for the build status
[03:45:07.931] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:45:07.931] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:293:0) after 1m0s
[03:46:08.173] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:293:0)
[03:46:08.173] Timer tick, asking Buildbucket for the build status
[03:46:08.302] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:46:08.302] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:294:0) after 1m0s
[03:47:08.553] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:294:0)
[03:47:08.553] Timer tick, asking Buildbucket for the build status
[03:47:08.982] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:47:08.982] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:295:0) after 1m0s
[03:48:09.106] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:295:0)
[03:48:09.106] Timer tick, asking Buildbucket for the build status
[03:48:09.217] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:48:09.217] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:296:0) after 1m0s
[03:49:09.468] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:296:0)
[03:49:09.468] Timer tick, asking Buildbucket for the build status
[03:49:09.530] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:49:09.530] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:297:0) after 1m0s
[03:50:09.786] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:297:0)
[03:50:09.786] Timer tick, asking Buildbucket for the build status
[03:50:09.943] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:50:09.943] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:298:0) after 1m0s
[03:51:10.046] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:298:0)
[03:51:10.046] Timer tick, asking Buildbucket for the build status
[03:51:10.585] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:51:10.585] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:299:0) after 1m0s
[03:52:10.752] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:299:0)
[03:52:10.752] Timer tick, asking Buildbucket for the build status
[03:52:10.882] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:52:10.882] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:300:0) after 1m0s
[03:53:10.980] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:300:0)
[03:53:10.980] Timer tick, asking Buildbucket for the build status
[03:53:11.198] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:53:11.198] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:301:0) after 1m0s
[03:54:11.268] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:301:0)
[03:54:11.268] Timer tick, asking Buildbucket for the build status
[03:54:11.373] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:54:11.373] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:302:0) after 1m0s
[03:55:11.430] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:302:0)
[03:55:11.430] Timer tick, asking Buildbucket for the build status
[03:55:11.531] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:55:11.531] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:303:0) after 1m0s
[03:56:11.602] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:303:0)
[03:56:11.602] Timer tick, asking Buildbucket for the build status
[03:56:11.811] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:56:11.811] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:304:0) after 1m0s
[03:57:11.872] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:304:0)
[03:57:11.872] Timer tick, asking Buildbucket for the build status
[03:57:12.011] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:57:12.011] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:305:0) after 1m0s
[03:58:12.059] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:305:0)
[03:58:12.059] Timer tick, asking Buildbucket for the build status
[03:58:12.295] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:58:12.295] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:306:0) after 1m0s
[03:59:12.422] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:306:0)
[03:59:12.422] Timer tick, asking Buildbucket for the build status
[03:59:12.765] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:59:12.765] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:307:0) after 1m0s
[04:00:12.870] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:307:0)
[04:00:12.870] Timer tick, asking Buildbucket for the build status
[04:00:13.489] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:00:13.490] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:308:0) after 1m0s
[04:01:13.527] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:308:0)
[04:01:13.527] Timer tick, asking Buildbucket for the build status
[04:01:13.991] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:01:13.991] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:309:0) after 1m0s
[04:02:14.211] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:309:0)
[04:02:14.211] Timer tick, asking Buildbucket for the build status
[04:02:14.817] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:02:14.817] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:310:0) after 1m0s
[04:03:15.250] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:310:0)
[04:03:15.250] Timer tick, asking Buildbucket for the build status
[04:03:15.387] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:03:15.387] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:311:0) after 1m0s
[04:04:15.420] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:311:0)
[04:04:15.420] Timer tick, asking Buildbucket for the build status
[04:04:15.900] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:04:15.900] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:312:0) after 1m0s
[04:05:15.945] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:312:0)
[04:05:15.945] Timer tick, asking Buildbucket for the build status
[04:05:16.190] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:05:16.190] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:313:0) after 1m0s
[04:06:16.365] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:313:0)
[04:06:16.365] Timer tick, asking Buildbucket for the build status
[04:06:16.583] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:06:16.583] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:314:0) after 1m0s
[04:07:16.676] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:314:0)
[04:07:16.676] Timer tick, asking Buildbucket for the build status
[04:07:16.854] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:07:16.854] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:315:0) after 1m0s
[04:08:16.982] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:315:0)
[04:08:16.982] Timer tick, asking Buildbucket for the build status
[04:08:17.108] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:08:17.108] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:316:0) after 1m0s
[04:09:17.179] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:316:0)
[04:09:17.179] Timer tick, asking Buildbucket for the build status
[04:09:17.588] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:09:17.588] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:317:0) after 1m0s
[04:10:17.669] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:317:0)
[04:10:17.669] Timer tick, asking Buildbucket for the build status
[04:10:17.776] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:10:17.776] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:318:0) after 1m0s
[04:11:18.065] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:318:0)
[04:11:18.065] Timer tick, asking Buildbucket for the build status
[04:11:18.253] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:11:18.253] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:319:0) after 1m0s
[04:12:18.291] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:319:0)
[04:12:18.291] Timer tick, asking Buildbucket for the build status
[04:12:18.752] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:12:18.752] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:320:0) after 1m0s
[04:13:18.895] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:320:0)
[04:13:18.895] Timer tick, asking Buildbucket for the build status
[04:13:19.003] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:13:19.003] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:321:0) after 1m0s
[04:14:19.045] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:321:0)
[04:14:19.045] Timer tick, asking Buildbucket for the build status
[04:14:19.389] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:14:19.389] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:322:0) after 1m0s
[04:15:19.469] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:322:0)
[04:15:19.469] Timer tick, asking Buildbucket for the build status
[04:15:19.585] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:15:19.585] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:323:0) after 1m0s
[04:16:19.658] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:323:0)
[04:16:19.658] Timer tick, asking Buildbucket for the build status
[04:16:19.843] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:16:19.843] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:324:0) after 1m0s
[04:17:19.885] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:324:0)
[04:17:19.885] Timer tick, asking Buildbucket for the build status
[04:17:20.035] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:17:20.035] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:325:0) after 1m0s
[04:18:20.148] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:325:0)
[04:18:20.149] Timer tick, asking Buildbucket for the build status
[04:18:20.645] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:18:20.645] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:326:0) after 1m0s
[04:19:20.682] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:326:0)
[04:19:20.682] Timer tick, asking Buildbucket for the build status
[04:19:21.218] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:19:21.218] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:327:0) after 1m0s
[04:20:21.263] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:327:0)
[04:20:21.263] Timer tick, asking Buildbucket for the build status
[04:20:21.405] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:20:21.405] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:328:0) after 1m0s
[04:21:21.591] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:328:0)
[04:21:21.591] Timer tick, asking Buildbucket for the build status
[04:21:21.721] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:21:21.721] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:329:0) after 1m0s
[04:22:21.763] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:329:0)
[04:22:21.763] Timer tick, asking Buildbucket for the build status
[04:22:22.057] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:22:22.057] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:330:0) after 1m0s
[04:23:22.094] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:330:0)
[04:23:22.094] Timer tick, asking Buildbucket for the build status
[04:23:22.309] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:23:22.309] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:331:0) after 1m0s
[04:24:22.395] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:331:0)
[04:24:22.395] Timer tick, asking Buildbucket for the build status
[04:24:22.509] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:24:22.509] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:332:0) after 1m0s
[04:25:22.568] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:332:0)
[04:25:22.568] Timer tick, asking Buildbucket for the build status
[04:25:22.821] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:25:22.821] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:333:0) after 1m0s
[04:26:22.874] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:333:0)
[04:26:22.874] Timer tick, asking Buildbucket for the build status
[04:26:23.188] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:26:23.188] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:334:0) after 1m0s
[04:27:23.273] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:334:0)
[04:27:23.273] Timer tick, asking Buildbucket for the build status
[04:27:23.640] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:27:23.640] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:335:0) after 1m0s
[04:28:23.757] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:335:0)
[04:28:23.757] Timer tick, asking Buildbucket for the build status
[04:28:23.923] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:28:23.923] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:336:0) after 1m0s
[04:29:23.937] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:336:0)
[04:29:23.937] Timer tick, asking Buildbucket for the build status
[04:29:24.095] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:29:24.095] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:337:0) after 1m0s
[04:30:24.138] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:337:0)
[04:30:24.138] Timer tick, asking Buildbucket for the build status
[04:30:24.499] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:30:24.499] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:338:0) after 1m0s
[04:31:24.527] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:338:0)
[04:31:24.527] Timer tick, asking Buildbucket for the build status
[04:31:24.888] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:31:24.888] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:339:0) after 1m0s
[04:32:24.963] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:339:0)
[04:32:24.963] Timer tick, asking Buildbucket for the build status
[04:32:25.373] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:32:25.373] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:340:0) after 1m0s
[04:33:25.481] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:340:0)
[04:33:25.481] Timer tick, asking Buildbucket for the build status
[04:33:25.637] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:33:25.637] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:341:0) after 1m0s
[04:34:25.775] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:341:0)
[04:34:25.775] Timer tick, asking Buildbucket for the build status
[04:34:25.912] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:34:25.912] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:342:0) after 1m0s
[04:35:25.941] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:342:0)
[04:35:25.941] Timer tick, asking Buildbucket for the build status
[04:35:26.195] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:35:26.195] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:343:0) after 1m0s
[04:36:26.249] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:343:0)
[04:36:26.249] Timer tick, asking Buildbucket for the build status
[04:36:26.424] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:36:26.424] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:344:0) after 1m0s
[04:37:26.561] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:344:0)
[04:37:26.561] Timer tick, asking Buildbucket for the build status
[04:37:26.842] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:37:26.842] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:345:0) after 1m0s
[04:38:26.928] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:345:0)
[04:38:26.928] Timer tick, asking Buildbucket for the build status
[04:38:27.398] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:38:27.398] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:346:0) after 1m0s
[04:39:27.451] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:346:0)
[04:39:27.451] Timer tick, asking Buildbucket for the build status
[04:39:27.873] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:39:27.873] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:347:0) after 1m0s
[04:40:27.963] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:347:0)
[04:40:27.963] Timer tick, asking Buildbucket for the build status
[04:40:28.347] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:40:28.347] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:348:0) after 1m0s
[04:41:28.479] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:348:0)
[04:41:28.479] Timer tick, asking Buildbucket for the build status
[04:41:28.693] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:41:28.693] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:349:0) after 1m0s
[04:42:28.736] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:349:0)
[04:42:28.736] Timer tick, asking Buildbucket for the build status
[04:42:28.874] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:42:28.874] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:350:0) after 1m0s
[04:43:28.935] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:350:0)
[04:43:28.935] Timer tick, asking Buildbucket for the build status
[04:43:29.085] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:43:29.085] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:351:0) after 1m0s
[04:44:29.342] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:351:0)
[04:44:29.342] Timer tick, asking Buildbucket for the build status
[04:44:29.483] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:44:29.483] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:352:0) after 1m0s
[04:45:29.561] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:352:0)
[04:45:29.561] Timer tick, asking Buildbucket for the build status
[04:45:29.678] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:45:29.678] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:353:0) after 1m0s
[04:46:29.837] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:353:0)
[04:46:29.837] Timer tick, asking Buildbucket for the build status
[04:46:30.262] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:46:30.262] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:354:0) after 1m0s
[04:47:30.378] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:354:0)
[04:47:30.378] Timer tick, asking Buildbucket for the build status
[04:47:30.577] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:47:30.577] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:355:0) after 1m0s
[04:48:30.773] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:355:0)
[04:48:30.773] Timer tick, asking Buildbucket for the build status
[04:48:31.192] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:48:31.193] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:356:0) after 1m0s
[04:49:31.233] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:356:0)
[04:49:31.233] Timer tick, asking Buildbucket for the build status
[04:49:31.420] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:49:31.420] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:357:0) after 1m0s
[04:50:31.523] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:357:0)
[04:50:31.523] Timer tick, asking Buildbucket for the build status
[04:50:31.882] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:50:31.882] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:358:0) after 1m0s
[04:51:31.922] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:358:0)
[04:51:31.922] Timer tick, asking Buildbucket for the build status
[04:51:32.052] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:51:32.052] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:359:0) after 1m0s
[04:52:32.168] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:359:0)
[04:52:32.168] Timer tick, asking Buildbucket for the build status
[04:52:32.353] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:52:32.353] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:360:0) after 1m0s
[04:53:32.397] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:360:0)
[04:53:32.397] Timer tick, asking Buildbucket for the build status
[04:53:32.563] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:53:32.563] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:361:0) after 1m0s
[04:54:32.608] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:361:0)
[04:54:32.608] Timer tick, asking Buildbucket for the build status
[04:54:32.750] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:54:32.750] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:362:0) after 1m0s
[04:55:32.747] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:362:0)
[04:55:32.747] Timer tick, asking Buildbucket for the build status
[04:55:32.883] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:55:32.883] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:363:0) after 1m0s
[04:56:33.185] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:363:0)
[04:56:33.185] Timer tick, asking Buildbucket for the build status
[04:56:33.437] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:56:33.437] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:364:0) after 1m0s
[04:57:33.483] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:364:0)
[04:57:33.483] Timer tick, asking Buildbucket for the build status
[04:57:33.636] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:57:33.636] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:365:0) after 1m0s
[04:58:33.755] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:365:0)
[04:58:33.755] Timer tick, asking Buildbucket for the build status
[04:58:33.884] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:58:33.884] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:366:0) after 1m0s
[04:59:33.946] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:366:0)
[04:59:33.946] Timer tick, asking Buildbucket for the build status
[04:59:34.129] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:59:34.129] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:367:0) after 1m0s
[05:00:34.197] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:367:0)
[05:00:34.197] Timer tick, asking Buildbucket for the build status
[05:00:34.331] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:00:34.331] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:368:0) after 1m0s
[05:01:34.371] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:368:0)
[05:01:34.371] Timer tick, asking Buildbucket for the build status
[05:01:34.615] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:01:34.615] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:369:0) after 1m0s
[05:02:34.738] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:369:0)
[05:02:34.738] Timer tick, asking Buildbucket for the build status
[05:02:35.042] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:02:35.042] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:370:0) after 1m0s
[05:03:35.226] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:370:0)
[05:03:35.226] Timer tick, asking Buildbucket for the build status
[05:03:35.382] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:03:35.382] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:371:0) after 1m0s
[05:04:35.478] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:371:0)
[05:04:35.478] Timer tick, asking Buildbucket for the build status
[05:04:35.682] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:04:35.682] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:372:0) after 1m0s
[05:05:35.769] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:372:0)
[05:05:35.769] Timer tick, asking Buildbucket for the build status
[05:05:35.845] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:05:35.845] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:373:0) after 1m0s
[05:06:35.877] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:373:0)
[05:06:35.877] Timer tick, asking Buildbucket for the build status
[05:06:36.092] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:06:36.092] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:374:0) after 1m0s
[05:07:36.183] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:374:0)
[05:07:36.183] Timer tick, asking Buildbucket for the build status
[05:07:36.446] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:07:36.446] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:375:0) after 1m0s
[05:08:36.477] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:375:0)
[05:08:36.477] Timer tick, asking Buildbucket for the build status
[05:08:36.599] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:08:36.599] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:376:0) after 1m0s
[05:09:36.657] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:376:0)
[05:09:36.657] Timer tick, asking Buildbucket for the build status
[05:09:36.826] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:09:36.826] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:377:0) after 1m0s
[05:10:36.879] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:377:0)
[05:10:36.879] Timer tick, asking Buildbucket for the build status
[05:10:37.406] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:10:37.406] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:378:0) after 1m0s
[05:11:37.494] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:378:0)
[05:11:37.495] Timer tick, asking Buildbucket for the build status
[05:11:37.795] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:11:37.795] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:379:0) after 1m0s
[05:12:37.881] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:379:0)
[05:12:37.882] Timer tick, asking Buildbucket for the build status
[05:12:38.258] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:12:38.258] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:380:0) after 1m0s
[05:13:38.348] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:380:0)
[05:13:38.348] Timer tick, asking Buildbucket for the build status
[05:13:38.835] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:13:38.835] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:381:0) after 1m0s
[05:14:38.881] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:381:0)
[05:14:38.881] Timer tick, asking Buildbucket for the build status
[05:14:39.034] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:14:39.034] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:382:0) after 1m0s
[05:15:39.030] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:382:0)
[05:15:39.030] Timer tick, asking Buildbucket for the build status
[05:15:39.178] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:15:39.178] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:383:0) after 1m0s
[05:16:39.332] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:383:0)
[05:16:39.332] Timer tick, asking Buildbucket for the build status
[05:16:39.552] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:16:39.552] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:384:0) after 1m0s
[05:17:39.683] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:384:0)
[05:17:39.683] Timer tick, asking Buildbucket for the build status
[05:17:39.809] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:17:39.809] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:385:0) after 1m0s
[05:18:39.929] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:385:0)
[05:18:39.930] Timer tick, asking Buildbucket for the build status
[05:18:40.067] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:18:40.067] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:386:0) after 1m0s
[05:19:40.213] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:386:0)
[05:19:40.213] Timer tick, asking Buildbucket for the build status
[05:19:40.307] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:19:40.307] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:387:0) after 1m0s
[05:20:40.338] Handling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:387:0)
[05:20:40.338] Timer tick, asking Buildbucket for the build status
[05:20:40.787] Build 8884000005485750080: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:20:40.787] Scheduling timer "check-buildbucket-build-status" (nacl/linux-64-validator-opt:9049430067523534528:388:0) after 1m0s
[05:21:03.202] Received PubSub notification, asking Buildbucket for the build status
[05:21:03.285] Build 8884000005485750080: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[05:21:03.285] Buildbucket build:
{
  "build": {
    "bucket": "luci.nacl.ci",
    "canary": true,
    "canary_preference": "CANARY",
    "completed_ts": "1585977661769550",
    "created_by": "project:nacl",
    "created_ts": "1585954390023140",
    "id": "8884000005485750080",
    "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\": \"d304d90ecc17351ce0fdab3e7452052a469c0976\"}, \"id\": \"https://chromium.googlesource.com/native_client/src/native_client.git/+/refs/heads/master@d304d90ecc17351ce0fdab3e7452052a469c0976\", \"title\": \"d304d90ecc17351ce0fdab3e7452052a469c0976\", \"url\": \"https://chromium.googlesource.com/native_client/src/native_client.git/+/d304d90ecc17351ce0fdab3e7452052a469c0976\"}]}, \"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/native_client/src/native_client.git\", \"revision\": \"d304d90ecc17351ce0fdab3e7452052a469c0976\"}}",
    "project": "nacl",
    "result": "SUCCESS",
    "result_details_json": "{\"properties\": {\"$recipe_engine/path\": {\"cache_dir\": \"/b/s/w/ir/cache\", \"temp_dir\": \"/b/s/w/ir/tmp/rt\"}, \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"$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\": \"d304d90ecc17351ce0fdab3e7452052a469c0976\"}, \"id\": \"https://chromium.googlesource.com/native_client/src/native_client.git/+/refs/heads/master@d304d90ecc17351ce0fdab3e7452052a469c0976\", \"title\": \"d304d90ecc17351ce0fdab3e7452052a469c0976\", \"url\": \"https://chromium.googlesource.com/native_client/src/native_client.git/+/d304d90ecc17351ce0fdab3e7452052a469c0976\"}]}, \"bot_id\": \"luci-flex-ci-xenial-9-oh4i\", \"branch\": \"refs/heads/master\", \"buildername\": \"linux-64-validator-opt\", \"buildnumber\": 136, \"got_revision\": \"d304d90ecc17351ce0fdab3e7452052a469c0976\", \"mastername\": \"client.nacl\", \"path_config\": \"generic\", \"recipe\": \"nacl\", \"repository\": \"https://chromium.googlesource.com/native_client/src/native_client.git\", \"revision\": \"d304d90ecc17351ce0fdab3e7452052a469c0976\", \"slavetype\": \"BuilderTester\"}, \"swarming\": {\"bot_dimensions\": {\"caches\": [\"builder_149fed94fc0315f63a3ac899b53d3cfedce2ab533d8d891f9abe32610aa3106a_v2\", \"builder_5bf551a0d5d177b55ce526f99d0a6f2ea5c5827f96722dd0bf2e7c331b5e9e59_v2\", \"builder_8c2b8eb547846015ec3d468eb69fd2552fa0ea4cc78e414f9bfe9b2362755d86_v2\", \"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-9-oh4i\"], \"image\": [\"chrome-xenial-20032900-6802ab9ce34\"], \"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\": [\"4926-84b94b1\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-west\", \"us-west1\", \"us-west1-b\"]}}}",
    "service_account": "nacl-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
    "started_ts": "1585954396995047",
    "status": "COMPLETED",
    "status_changed_ts": "1585977662286346",
    "tags": [
      "build_address:luci.nacl.ci/linux-64-validator-opt/136",
      "builder:linux-64-validator-opt",
      "buildset:commit/git/d304d90ecc17351ce0fdab3e7452052a469c0976",
      "buildset:commit/gitiles/chromium.googlesource.com/native_client/src/native_client/+/d304d90ecc17351ce0fdab3e7452052a469c0976",
      "gitiles_ref:refs/heads/master",
      "scheduler_invocation_id:9049430067523534528",
      "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/8884000005485750080/+/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:4b5b1115c06baf10",
      "user_agent:luci-scheduler"
    ],
    "updated_ts": "1585977662301163",
    "url": "https://ci.chromium.org/b/8884000005485750080",
    "utcnow_ts": "1585977663276940"
  }
}
[05:21:03.285] Invocation finished in 6h27m54.589417568s with status SUCCEEDED