Status: SUCCEEDED
Triggered by: -
Duration: 1 hour
Actions:

Definition (rev 61da5958bb1bf61dc6dab9a9ab14fa46798b5d0f)

buildbucket: <
  server: "cr-buildbucket.appspot.com"
  bucket: "luci.chromium.ci"
  builder: "linux-chromeos-dbg"
>

Incoming triggers

Incoming properties

{
  "branch": "refs/heads/master",
  "repository": "https://chromium.googlesource.com/chromium/src",
  "revision": "756f3737565dc56b32ec865ce6079ab9f8c361a4"
}

Incoming tags

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

Debug log (UTC)

[15:55:08.131] New invocation is queued and will start shortly
[15:55:09.988] Starting the invocation (attempt 1)
[15:55:10.035] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[15:55:10.038] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[15:55:10.038] Buildbucket request:
{
  "bucket": "luci.chromium.ci",
  "client_operation_id": "9031155779206978960",
  "parameters_json": "{\"builder_name\":\"linux-chromeos-dbg\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"756f3737565dc56b32ec865ce6079ab9f8c361a4\"}}",
  "pubsub_callback": {
    "auth_token": "...",
    "topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
  },
  "tags": [
    "builder:linux-chromeos-dbg",
    "scheduler_invocation_id:9031155779206978960",
    "scheduler_job_id:chromium/linux-chromeos-dbg",
    "user_agent:luci-scheduler",
    "buildset:commit/git/756f3737565dc56b32ec865ce6079ab9f8c361a4",
    "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/756f3737565dc56b32ec865ce6079ab9f8c361a4",
    "gitiles_ref:refs/heads/master"
  ]
}
[15:55:11.773] Buildbucket response:
{
  "build": {
    "bucket": "luci.chromium.ci",
    "canary_preference": "PROD",
    "created_by": "project:chromium",
    "created_ts": "1603382110198057",
    "id": "8865725716375245120",
    "parameters_json": "{\"builder_name\": \"linux-chromeos-dbg\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"756f3737565dc56b32ec865ce6079ab9f8c361a4\"}}",
    "project": "chromium",
    "result_details_json": "{\"properties\": {}}",
    "service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
    "status": "SCHEDULED",
    "status_changed_ts": "1603382111538221",
    "tags": [
      "build_address:luci.chromium.ci/linux-chromeos-dbg/20965",
      "builder:linux-chromeos-dbg",
      "buildset:commit/git/756f3737565dc56b32ec865ce6079ab9f8c361a4",
      "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/756f3737565dc56b32ec865ce6079ab9f8c361a4",
      "gitiles_ref:refs/heads/master",
      "scheduler_invocation_id:9031155779206978960",
      "scheduler_job_id:chromium/linux-chromeos-dbg",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8865725716375245120/+/annotations",
      "swarming_tag:luci_project:chromium",
      "swarming_tag:recipe_name:chromium",
      "swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
      "swarming_task_id:",
      "user_agent:luci-scheduler"
    ],
    "updated_ts": "1603382111538364",
    "url": "https://ci.chromium.org/b/8865725716375245120",
    "utcnow_ts": "1603382111761882"
  }
}
[15:55:11.773] Task URL: https://ci.chromium.org/b/8865725716375245120
[15:55:11.773] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:2:0) after 1m0s
[15:56:11.801] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:2:0)
[15:56:11.801] Timer tick, asking Buildbucket for the build status
[15:56:11.981] Build 8865725716375245120: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[15:56:11.981] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:3:0) after 1m0s
[15:57:12.065] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:3:0)
[15:57:12.065] Timer tick, asking Buildbucket for the build status
[15:57:12.304] Build 8865725716375245120: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[15:57:12.305] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:4:0) after 1m0s
[15:58:12.379] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:4:0)
[15:58:12.379] Timer tick, asking Buildbucket for the build status
[15:58:12.463] Build 8865725716375245120: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[15:58:12.463] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:5:0) after 1m0s
[15:58:44.610] Received PubSub notification, asking Buildbucket for the build status
[15:58:44.707] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:59:12.485] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:5:0)
[15:59:12.485] Timer tick, asking Buildbucket for the build status
[15:59:12.573] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:59:12.573] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:7:0) after 1m0s
[16:00:12.598] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:7:0)
[16:00:12.598] Timer tick, asking Buildbucket for the build status
[16:00:12.799] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:00:12.799] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:8:0) after 1m0s
[16:01:12.925] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:8:0)
[16:01:12.925] Timer tick, asking Buildbucket for the build status
[16:01:13.064] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:01:13.064] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:9:0) after 1m0s
[16:02:13.108] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:9:0)
[16:02:13.108] Timer tick, asking Buildbucket for the build status
[16:02:13.198] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:02:13.198] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:10:0) after 1m0s
[16:03:13.223] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:10:0)
[16:03:13.223] Timer tick, asking Buildbucket for the build status
[16:03:13.370] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:03:13.370] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:11:0) after 1m0s
[16:04:13.408] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:11:0)
[16:04:13.408] Timer tick, asking Buildbucket for the build status
[16:04:13.699] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:04:13.699] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:12:0) after 1m0s
[16:05:13.798] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:12:0)
[16:05:13.798] Timer tick, asking Buildbucket for the build status
[16:05:13.939] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:05:13.939] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:13:0) after 1m0s
[16:06:13.999] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:13:0)
[16:06:13.999] Timer tick, asking Buildbucket for the build status
[16:06:14.114] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:06:14.114] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:14:0) after 1m0s
[16:07:14.140] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:14:0)
[16:07:14.140] Timer tick, asking Buildbucket for the build status
[16:07:14.374] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:07:14.374] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:15:0) after 1m0s
[16:08:14.479] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:15:0)
[16:08:14.479] Timer tick, asking Buildbucket for the build status
[16:08:14.562] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:08:14.562] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:16:0) after 1m0s
[16:09:14.661] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:16:0)
[16:09:14.661] Timer tick, asking Buildbucket for the build status
[16:09:14.783] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:09:14.783] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:17:0) after 1m0s
[16:10:14.876] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:17:0)
[16:10:14.876] Timer tick, asking Buildbucket for the build status
[16:10:14.989] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:10:14.989] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:18:0) after 1m0s
[16:11:15.107] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:18:0)
[16:11:15.107] Timer tick, asking Buildbucket for the build status
[16:11:15.196] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:11:15.196] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:19:0) after 1m0s
[16:12:15.241] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:19:0)
[16:12:15.241] Timer tick, asking Buildbucket for the build status
[16:12:15.394] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:12:15.394] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:20:0) after 1m0s
[16:13:15.369] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:20:0)
[16:13:15.369] Timer tick, asking Buildbucket for the build status
[16:13:16.260] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:13:16.260] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:21:0) after 1m0s
[16:14:16.429] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:21:0)
[16:14:16.429] Timer tick, asking Buildbucket for the build status
[16:14:16.522] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:14:16.522] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:22:0) after 1m0s
[16:15:16.539] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:22:0)
[16:15:16.539] Timer tick, asking Buildbucket for the build status
[16:15:16.767] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:15:16.767] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:23:0) after 1m0s
[16:16:16.816] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:23:0)
[16:16:16.816] Timer tick, asking Buildbucket for the build status
[16:16:16.883] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:16:16.883] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:24:0) after 1m0s
[16:17:16.940] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:24:0)
[16:17:16.940] Timer tick, asking Buildbucket for the build status
[16:17:17.011] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:17:17.011] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:25:0) after 1m0s
[16:18:17.062] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:25:0)
[16:18:17.062] Timer tick, asking Buildbucket for the build status
[16:18:17.198] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:18:17.198] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:26:0) after 1m0s
[16:19:17.232] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:26:0)
[16:19:17.234] Timer tick, asking Buildbucket for the build status
[16:19:17.318] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:19:17.319] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:27:0) after 1m0s
[16:20:17.362] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:27:0)
[16:20:17.362] Timer tick, asking Buildbucket for the build status
[16:20:17.507] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:20:17.507] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:28:0) after 1m0s
[16:21:17.538] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:28:0)
[16:21:17.538] Timer tick, asking Buildbucket for the build status
[16:21:17.611] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:21:17.611] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:29:0) after 1m0s
[16:22:17.720] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:29:0)
[16:22:17.720] Timer tick, asking Buildbucket for the build status
[16:22:17.773] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:22:17.773] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:30:0) after 1m0s
[16:23:17.837] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:30:0)
[16:23:17.837] Timer tick, asking Buildbucket for the build status
[16:23:17.914] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:23:17.914] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:31:0) after 1m0s
[16:24:17.938] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:31:0)
[16:24:17.938] Timer tick, asking Buildbucket for the build status
[16:24:18.017] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:24:18.017] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:32:0) after 1m0s
[16:25:18.071] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:32:0)
[16:25:18.071] Timer tick, asking Buildbucket for the build status
[16:25:18.820] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:25:18.820] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:33:0) after 1m0s
[16:26:18.854] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:33:0)
[16:26:18.854] Timer tick, asking Buildbucket for the build status
[16:26:18.996] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:26:18.996] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:34:0) after 1m0s
[16:27:18.977] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:34:0)
[16:27:18.977] Timer tick, asking Buildbucket for the build status
[16:27:19.114] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:27:19.114] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:35:0) after 1m0s
[16:28:19.143] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:35:0)
[16:28:19.143] Timer tick, asking Buildbucket for the build status
[16:28:19.261] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:28:19.261] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:36:0) after 1m0s
[16:29:19.351] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:36:0)
[16:29:19.351] Timer tick, asking Buildbucket for the build status
[16:29:19.455] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:29:19.455] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:37:0) after 1m0s
[16:30:19.471] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:37:0)
[16:30:19.471] Timer tick, asking Buildbucket for the build status
[16:30:19.583] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:30:19.583] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:38:0) after 1m0s
[16:31:19.602] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:38:0)
[16:31:19.602] Timer tick, asking Buildbucket for the build status
[16:31:19.671] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:31:19.671] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:39:0) after 1m0s
[16:32:19.724] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:39:0)
[16:32:19.724] Timer tick, asking Buildbucket for the build status
[16:32:19.786] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:32:19.786] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:40:0) after 1m0s
[16:33:19.790] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:40:0)
[16:33:19.790] Timer tick, asking Buildbucket for the build status
[16:33:19.859] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:33:19.859] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:41:0) after 1m0s
[16:34:19.886] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:41:0)
[16:34:19.886] Timer tick, asking Buildbucket for the build status
[16:34:20.088] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:34:20.088] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:42:0) after 1m0s
[16:35:20.126] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:42:0)
[16:35:20.126] Timer tick, asking Buildbucket for the build status
[16:35:20.391] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:35:20.391] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:43:0) after 1m0s
[16:36:20.439] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:43:0)
[16:36:20.439] Timer tick, asking Buildbucket for the build status
[16:36:20.567] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:36:20.567] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:44:0) after 1m0s
[16:37:20.609] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:44:0)
[16:37:20.609] Timer tick, asking Buildbucket for the build status
[16:37:20.979] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:37:20.979] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:45:0) after 1m0s
[16:38:21.098] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:45:0)
[16:38:21.098] Timer tick, asking Buildbucket for the build status
[16:38:21.194] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:38:21.194] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:46:0) after 1m0s
[16:39:21.217] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:46:0)
[16:39:21.217] Timer tick, asking Buildbucket for the build status
[16:39:21.322] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:39:21.322] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:47:0) after 1m0s
[16:40:21.377] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:47:0)
[16:40:21.377] Timer tick, asking Buildbucket for the build status
[16:40:21.748] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:40:21.748] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:48:0) after 1m0s
[16:41:21.812] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:48:0)
[16:41:21.812] Timer tick, asking Buildbucket for the build status
[16:41:21.913] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:41:21.913] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:49:0) after 1m0s
[16:42:21.951] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:49:0)
[16:42:21.951] Timer tick, asking Buildbucket for the build status
[16:42:22.145] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:42:22.145] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:50:0) after 1m0s
[16:43:22.168] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:50:0)
[16:43:22.168] Timer tick, asking Buildbucket for the build status
[16:43:22.290] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:43:22.290] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:51:0) after 1m0s
[16:44:22.336] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:51:0)
[16:44:22.336] Timer tick, asking Buildbucket for the build status
[16:44:22.447] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:44:22.447] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:52:0) after 1m0s
[16:45:22.528] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:52:0)
[16:45:22.528] Timer tick, asking Buildbucket for the build status
[16:45:22.642] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:45:22.642] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:53:0) after 1m0s
[16:46:22.684] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:53:0)
[16:46:22.684] Timer tick, asking Buildbucket for the build status
[16:46:23.135] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:46:23.135] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:54:0) after 1m0s
[16:47:23.202] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:54:0)
[16:47:23.202] Timer tick, asking Buildbucket for the build status
[16:47:23.704] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:47:23.704] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:55:0) after 1m0s
[16:48:23.801] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:55:0)
[16:48:23.801] Timer tick, asking Buildbucket for the build status
[16:48:25.011] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:48:25.011] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:56:0) after 1m0s
[16:49:25.063] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:56:0)
[16:49:25.063] Timer tick, asking Buildbucket for the build status
[16:49:25.210] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:49:25.210] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:57:0) after 1m0s
[16:50:25.222] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:57:0)
[16:50:25.222] Timer tick, asking Buildbucket for the build status
[16:50:25.331] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:50:25.331] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:58:0) after 1m0s
[16:51:25.407] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:58:0)
[16:51:25.407] Timer tick, asking Buildbucket for the build status
[16:51:25.478] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:51:25.478] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:59:0) after 1m0s
[16:52:25.532] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:59:0)
[16:52:25.532] Timer tick, asking Buildbucket for the build status
[16:52:26.128] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:52:26.128] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:60:0) after 1m0s
[16:53:26.167] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:60:0)
[16:53:26.167] Timer tick, asking Buildbucket for the build status
[16:53:26.293] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:53:26.293] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:61:0) after 1m0s
[16:54:26.308] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:61:0)
[16:54:26.308] Timer tick, asking Buildbucket for the build status
[16:54:26.447] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:54:26.447] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:62:0) after 1m0s
[16:55:26.501] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:62:0)
[16:55:26.501] Timer tick, asking Buildbucket for the build status
[16:55:27.017] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:55:27.017] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:63:0) after 1m0s
[16:56:27.060] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:63:0)
[16:56:27.060] Timer tick, asking Buildbucket for the build status
[16:56:27.301] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:56:27.301] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:64:0) after 1m0s
[16:57:27.349] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:64:0)
[16:57:27.349] Timer tick, asking Buildbucket for the build status
[16:57:27.628] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:57:27.628] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:65:0) after 1m0s
[16:58:27.719] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:65:0)
[16:58:27.719] Timer tick, asking Buildbucket for the build status
[16:58:27.796] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:58:27.796] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:66:0) after 1m0s
[16:59:27.871] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:66:0)
[16:59:27.871] Timer tick, asking Buildbucket for the build status
[16:59:27.954] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:59:27.954] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:67:0) after 1m0s
[17:00:28.144] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:67:0)
[17:00:28.144] Timer tick, asking Buildbucket for the build status
[17:00:28.257] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:00:28.257] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:68:0) after 1m0s
[17:01:28.727] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:68:0)
[17:01:28.727] Timer tick, asking Buildbucket for the build status
[17:01:29.102] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:01:29.102] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:69:0) after 1m0s
[17:02:29.252] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:69:0)
[17:02:29.252] Timer tick, asking Buildbucket for the build status
[17:02:29.907] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:02:29.907] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:70:0) after 1m0s
[17:03:30.187] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:70:0)
[17:03:30.187] Timer tick, asking Buildbucket for the build status
[17:03:30.277] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:03:30.277] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:71:0) after 1m0s
[17:04:30.351] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:71:0)
[17:04:30.351] Timer tick, asking Buildbucket for the build status
[17:04:30.626] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:04:30.626] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:72:0) after 1m0s
[17:05:30.992] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:72:0)
[17:05:30.992] Timer tick, asking Buildbucket for the build status
[17:05:31.887] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:05:31.887] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:73:0) after 1m0s
[17:06:32.062] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:73:0)
[17:06:32.062] Timer tick, asking Buildbucket for the build status
[17:06:32.612] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:06:32.612] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:74:0) after 1m0s
[17:07:32.769] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:74:0)
[17:07:32.769] Timer tick, asking Buildbucket for the build status
[17:07:32.852] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:07:32.852] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:75:0) after 1m0s
[17:08:33.660] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:75:0)
[17:08:33.660] Timer tick, asking Buildbucket for the build status
[17:08:33.821] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:08:33.821] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:76:0) after 1m0s
[17:09:33.921] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:76:0)
[17:09:33.921] Timer tick, asking Buildbucket for the build status
[17:09:34.452] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:09:34.456] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:77:0) after 1m0s
[17:10:34.518] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:77:0)
[17:10:34.518] Timer tick, asking Buildbucket for the build status
[17:10:34.998] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:10:34.998] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:78:0) after 1m0s
[17:11:35.054] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:78:0)
[17:11:35.054] Timer tick, asking Buildbucket for the build status
[17:11:35.230] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:11:35.230] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:79:0) after 1m0s
[17:12:35.291] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:79:0)
[17:12:35.291] Timer tick, asking Buildbucket for the build status
[17:12:35.509] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:12:35.509] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:80:0) after 1m0s
[17:13:35.608] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:80:0)
[17:13:35.608] Timer tick, asking Buildbucket for the build status
[17:13:35.754] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:13:35.754] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:81:0) after 1m0s
[17:14:35.870] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:81:0)
[17:14:35.871] Timer tick, asking Buildbucket for the build status
[17:14:36.013] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:14:36.013] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:82:0) after 1m0s
[17:15:36.144] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:82:0)
[17:15:36.144] Timer tick, asking Buildbucket for the build status
[17:15:36.294] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:15:36.294] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:83:0) after 1m0s
[17:16:36.310] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:83:0)
[17:16:36.310] Timer tick, asking Buildbucket for the build status
[17:16:36.720] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:16:36.720] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:84:0) after 1m0s
[17:17:36.844] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:84:0)
[17:17:36.844] Timer tick, asking Buildbucket for the build status
[17:17:37.004] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:17:37.005] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:85:0) after 1m0s
[17:18:37.057] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:85:0)
[17:18:37.057] Timer tick, asking Buildbucket for the build status
[17:18:37.497] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:18:37.497] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:86:0) after 1m0s
[17:19:37.549] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:86:0)
[17:19:37.549] Timer tick, asking Buildbucket for the build status
[17:19:37.801] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:19:37.801] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:87:0) after 1m0s
[17:20:37.866] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:87:0)
[17:20:37.866] Timer tick, asking Buildbucket for the build status
[17:20:38.009] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:20:38.009] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:88:0) after 1m0s
[17:21:38.037] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:88:0)
[17:21:38.037] Timer tick, asking Buildbucket for the build status
[17:21:38.115] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:21:38.115] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:89:0) after 1m0s
[17:22:38.119] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:89:0)
[17:22:38.119] Timer tick, asking Buildbucket for the build status
[17:22:38.193] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:22:38.193] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:90:0) after 1m0s
[17:23:38.317] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:90:0)
[17:23:38.317] Timer tick, asking Buildbucket for the build status
[17:23:38.495] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:23:38.495] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:91:0) after 1m0s
[17:24:38.601] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:91:0)
[17:24:38.601] Timer tick, asking Buildbucket for the build status
[17:24:38.674] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:24:38.674] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:92:0) after 1m0s
[17:25:38.844] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:92:0)
[17:25:38.844] Timer tick, asking Buildbucket for the build status
[17:25:38.963] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:25:38.963] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:93:0) after 1m0s
[17:26:39.987] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:93:0)
[17:26:39.987] Timer tick, asking Buildbucket for the build status
[17:26:40.127] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:26:40.127] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:94:0) after 1m0s
[17:27:40.274] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:94:0)
[17:27:40.274] Timer tick, asking Buildbucket for the build status
[17:27:40.382] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:27:40.382] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:95:0) after 1m0s
[17:28:40.511] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:95:0)
[17:28:40.511] Timer tick, asking Buildbucket for the build status
[17:28:40.595] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:28:40.595] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:96:0) after 1m0s
[17:29:40.674] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:96:0)
[17:29:40.674] Timer tick, asking Buildbucket for the build status
[17:29:40.747] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:29:40.747] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:97:0) after 1m0s
[17:30:41.543] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:97:0)
[17:30:41.543] Timer tick, asking Buildbucket for the build status
[17:30:41.925] Build 8865725716375245120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:30:41.925] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9031155779206978960:98:0) after 1m0s
[17:31:14.460] Received PubSub notification, asking Buildbucket for the build status
[17:31:14.799] Build 8865725716375245120: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[17:31:14.799] Buildbucket build:
{
  "build": {
    "bucket": "luci.chromium.ci",
    "canary_preference": "PROD",
    "completed_ts": "1603387873668523",
    "created_by": "project:chromium",
    "created_ts": "1603382110198057",
    "id": "8865725716375245120",
    "parameters_json": "{\"builder_name\": \"linux-chromeos-dbg\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"756f3737565dc56b32ec865ce6079ab9f8c361a4\"}}",
    "project": "chromium",
    "result": "SUCCESS",
    "result_details_json": "{\"properties\": {\"$build/goma\": {\"enable_ats\": true, \"rpc_extra_params\": \"?prod\", \"server_host\": \"goma.chromium.org\", \"use_luci_auth\": true}, \"$recipe_engine/isolated\": {\"server\": \"https://isolateserver.appspot.com\"}, \"$recipe_engine/milo/blamelist_pins\": [{\"host\": \"chromium.googlesource.com\", \"id\": \"756f3737565dc56b32ec865ce6079ab9f8c361a4\", \"project\": \"chromium/src\"}], \"$recipe_engine/path\": {\"cache_dir\": \"/b/s/w/ir/cache\", \"temp_dir\": \"/b/s/w/ir/tmp/rt\"}, \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"bot_id\": \"luci-chromium-ci-xenial-us-central1-b-8-9-csso\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.chromiumos\", \"buildername\": \"linux-chromeos-dbg\", \"buildnumber\": 20965, \"got_angle_revision\": \"1c7f0284516ac7db02f4b9d9626d810488177b22\", \"got_dawn_revision\": \"22505a5afe1f75b402a00a27d49e313fbd6e2181\", \"got_nacl_revision\": \"0fabd6dc4222dfae664e55a84326e0c904f5b62c\", \"got_revision\": \"756f3737565dc56b32ec865ce6079ab9f8c361a4\", \"got_revision_cp\": \"refs/heads/master@{#819846}\", \"got_swarming_client_revision\": \"d46ea7635f2911208268170512cb611412488fd8\", \"got_swiftshader_revision\": \"df17a76102dfabb3f1bd6e51449cece9f77b45e3\", \"got_v8_revision\": \"d9ccb94fc2738d2c7bec626c287518c5e3ad14e9\", \"got_v8_revision_cp\": \"refs/heads/8.8.149@{#1}\", \"got_webrtc_revision\": \"7bc3356fbcb9b95ea2c810ae2f3152930d54577b\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#32449}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"756f3737565dc56b32ec865ce6079ab9f8c361a4\", \"swarm_hashes_refs/heads/master(at){#819846}_without_patch\": {\"absl_hardening_tests\": \"899f60c03573d37f53f6360c5e2487feeefc046e\", \"accessibility_unittests\": \"dadcca3e8ccf2299d519aba057251e6edbcecc5d\", \"app_list_unittests\": \"912135e1ab205248290a57e5473f557309905088\", \"app_shell_unittests\": \"68056d1d44af0ee767e444d61c5d0c94e7d94b23\", \"ash_unittests\": \"b756eebc63bd011883bad508559a55dc11ccd5be\", \"aura_unittests\": \"aad534a5735429300af2622b4a7e136bc436f110\", \"base_unittests\": \"e7466f19c56cbee6ad7fef805d67d22049a48d85\", \"base_util_unittests\": \"4d02c5dc6ea57376dcd434a1c8bd40f66a3d4aad\", \"blink_common_unittests\": \"455c7e38dcc8e9c263843c8254c3cadd3e9f8515\", \"blink_fuzzer_unittests\": \"e89772a57aad28317bd7310016b91dde530c2b42\", \"blink_heap_unittests\": \"d64a7d446dfe8c3223faa01c9bda769c494f2dab\", \"blink_platform_unittests\": \"5d16ebc0374879587a3f3e3776a4899b7fc05423\", \"blink_unittests\": \"3a9d852ed617d13cf403137eba4cc2eb78560136\", \"boringssl_crypto_tests\": \"ff573c555b615ec6217bceab32fc24a8830d4a03\", \"boringssl_ssl_tests\": \"f803ecd4fb924ae4f56f41e0bf3fbb40c3140ab4\", \"browser_tests\": \"eb565aa57faf9d83d9327511d451e198fd04f277\", \"capture_unittests\": \"4dbbc609eee57d206ebad7c93b355ef3e6497dba\", \"cast_unittests\": \"7d7f2beac5756aabe42c6236d8047ab6c4de7de0\", \"cc_unittests\": \"e7d71cb5dd5addce1a6e90989dce7a4f1f11e76c\", \"chrome_app_unittests\": \"8474ee1969aeec1c9ec92fd7a9f35cb4487e6209\", \"chromedriver_unittests\": \"8bbc586eec52e949615f0d83d8433d7240136efb\", \"chromeos_components_unittests\": \"ca1563e7235ea366976dda57844c24bf700e6d9d\", \"chromeos_unittests\": \"24cab5d29dd55f22067a291e422a967a9277d603\", \"components_browsertests\": \"23dd5797751a521f2a5ed4a6e0baf051f91bc100\", \"components_unittests\": \"be9f0f19eba48f630528ecd3dc9ef6354dc344f2\", \"compositor_unittests\": \"1f1fd7e0225b0d36ce44c936959146e02e093a0c\", \"content_browsertests\": \"caeb8230e819d64e66ca450e885228e2aabd1bed\", \"content_unittests\": \"43f6bdbd066a2a705ff8e66ba1df3e2881789188\", \"crypto_unittests\": \"2b2d5ef8f887f91e4b0d905f599a3cba4e14ddfe\", \"dbus_unittests\": \"a49b54453815f05b1d012db24a3755539d8664e6\", \"device_unittests\": \"6d2a3797e0e9d305870e14910eb544a28baddaa4\", \"display_unittests\": \"9ac9788b40829277faceeca51c07300ae3e409ec\", \"events_unittests\": \"1eb6dd9fcb894b4f81ce60fce178b1b137a468af\", \"exo_unittests\": \"fdbf8a7244ff68d4e1ab6ee258127058dd21d365\", \"extensions_browsertests\": \"97f2dcb31eb2cc6695eb6b656bf7f0454d39a08b\", \"extensions_unittests\": \"3787415f303492c8f78457f32277648b060c50aa\", \"filesystem_service_unittests\": \"538d0160b334ae2ec0dab97e87220d7c61567c1f\", \"gcm_unit_tests\": \"80d9ad1291d42625f4123d88563beb59a55ca0dd\", \"gfx_unittests\": \"43a6028e412827be26b645782f77b8458f04e7d5\", \"gin_unittests\": \"5f996c55da09bd7d5ef45bd8116bd4bce7fa7f50\", \"gl_unittests_ozone\": \"187323fcdc46b0ef75a88386c7a3d80802596359\", \"google_apis_unittests\": \"5e2888b507d792ee47b6cba41e05e9d001bcd01d\", \"gpu_unittests\": \"6952243570b6b5faac894af6516d880110866d5f\", \"gwp_asan_unittests\": \"9808bcab6d307df9e5eb42c913cdc40fedf31163\", \"interactive_ui_tests\": \"d05646c04d8ede79bc6bb76bdf226d7b9c71e67f\", \"ipc_tests\": \"79a02fc310444ae5d994eda3f1c29c9da5013228\", \"jingle_unittests\": \"0fd4e8ab3676e5cc82ab9f8fb5ec5b554bbbca77\", \"keyboard_unittests\": \"4a2d81f3776fbb6a03a352e505a9066d709fd334\", \"latency_unittests\": \"28b3ed31c74d5ea15c2000d18e985a1dd6436b0b\", \"libjingle_xmpp_unittests\": \"36647b76a095917a46dc2eadaf6076a6a07de6f5\", \"media_blink_unittests\": \"72de1cbef171c40dc1bf955be7ed566e03da433f\", \"media_unittests\": \"702ca5072757a69a7088348ac39fe426c9b53248\", \"message_center_unittests\": \"1e209aef91dcd73654895ec1758c8b6647f94cde\", \"midi_unittests\": \"9ee013b27d0f3b684493ff9613b3770890d06b78\", \"mojo_core_unittests\": \"127ce4af44755d1be8f0777d76f27eb023b3bccf\", \"mojo_unittests\": \"57a20501bfdfc9863d5506b4fa0f07ff2e8d33f9\", \"nacl_helper_nonsfi_unittests\": \"60304ed39f412753868ebd7b184227716609a7ce\", \"nacl_loader_unittests\": \"115b1165efedf92908d758870e30b0fa01547f7b\", \"native_theme_unittests\": \"c28103ffea10be289ecb880807f2f3e3183b7260\", \"net_unittests\": \"2a94d22457f2091491e78d85e94287658a64b5f5\", \"ozone_gl_unittests\": \"232125c3bf8b6c3c832fc124f305a94cebee95ea\", \"ozone_unittests\": \"b1014d2cb63ecf8268475c05d811eea5fa00709b\", \"ozone_x11_unittests\": \"30498e7d44f537649992b2481d070c885d8eaab6\", \"pdf_unittests\": \"2a296cfe1b6a78c77c7458de818f72240fffc7df\", \"perfetto_unittests\": \"8d55f652134d653bd1fc2db1a7f8d60d3026c5c6\", \"ppapi_unittests\": \"c12f26d99717b4dda82e4932ace3cc4850f6170c\", \"printing_unittests\": \"6db2291b6032ff3ae27a82c56255e9329c34b32c\", \"remoting_unittests\": \"325b8c16f382c7b77447217799b197ce93dfbbec\", \"sandbox_linux_unittests\": \"977563b296c5fc87dd5def0de54a32205f2729ea\", \"service_manager_unittests\": \"c1c4b980d94a5febade543a89f8d23ef8292dd2c\", \"services_unittests\": \"9a09ecf84e327c80bcd6f3d526152d4cd897ca31\", \"shell_dialogs_unittests\": \"02a09bb3031dc6afddc3de44ea1683596700a1af\", \"skia_unittests\": \"a6af90fa6ca46fcd73994e94f40511ee34d54f9e\", \"snapshot_unittests\": \"63ddbc48a845483384c1e0a5cacd14aff8ec3f61\", \"sql_unittests\": \"044a4461adbab04ad207b769a85a9766b31bbb22\", \"standalone_angle_unittests\": \"832d5be09ce9debcc76dadac10c06de6a049ac60\", \"storage_unittests\": \"9053d2c7a79f64e09e598a666bc128059d613000\", \"sync_integration_tests\": \"45f53bb7356718b2e07ab2f442457666f642e414\", \"traffic_annotation_auditor_unittests\": \"b29bddb1eca40e4685537b60d5905d3df24fdcbe\", \"ui_base_unittests\": \"9d04c61cdea4dde930ccaf988557b423fadb7192\", \"ui_chromeos_unittests\": \"3afc992024104bae7b191a26ae2cec234112e7cc\", \"ui_touch_selection_unittests\": \"615c4ec25cf6adf545a37e9951ff711da312c58e\", \"unit_tests\": \"fd4ceebf148036f0f3cd59d39fb3c9dfb2c196f0\", \"url_unittests\": \"c925378c165f6b9ea760e65593770b3945886b7b\", \"usage_time_limit_unittests\": \"313e39701a335cb0855b284cf0d4ffbb20b52078\", \"views_unittests\": \"b9520c4edf85f7880d18c37881c786aa40b2a6a3\", \"viz_unittests\": \"beaf3f778dfb8b260c5beca5b3b42882f080da4d\", \"wm_unittests\": \"8ad69f0fc5258ee589975c19467d2f6f947932f7\", \"wtf_unittests\": \"a9951c820b5a1ff702ac255e0384cf3d3e13bb55\", \"zlib_unittests\": \"32860b03ec5dc84dd224c181a6a0abf891077b77\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_4973d939604d11dcbaec68575e69c80c756ff63e355ab013b29b8bca26434b7c_v2\", \"builder_a1b9c6892397d61c3624774723419f5ae48fcf776e7d2304bd4682bf5cd4c049_v2\", \"builder_dacf669b49e3ec352df995227b58e62a545590985cca62e76e0831f920af4ccd_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"8\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Haswell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"luci-chromium-ci-xenial-us-central1-b-8-9-csso\"], \"image\": [\"chrome-xenial-20101800-2d400e1627f\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"e2-standard-8\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-16\", \"Ubuntu-16.04\", \"Ubuntu-16.04.6\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.12\"], \"server_version\": [\"5612-26d29a7\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"]}}}",
    "service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
    "started_ts": "1603382324108544",
    "status": "COMPLETED",
    "status_changed_ts": "1603387873956239",
    "tags": [
      "build_address:luci.chromium.ci/linux-chromeos-dbg/20965",
      "builder:linux-chromeos-dbg",
      "buildset:commit/git/756f3737565dc56b32ec865ce6079ab9f8c361a4",
      "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/756f3737565dc56b32ec865ce6079ab9f8c361a4",
      "gitiles_ref:refs/heads/master",
      "scheduler_invocation_id:9031155779206978960",
      "scheduler_job_id:chromium/linux-chromeos-dbg",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8865725716375245120/+/annotations",
      "swarming_tag:luci_project:chromium",
      "swarming_tag:os:Linux",
      "swarming_tag:recipe_name:chromium",
      "swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
      "swarming_task_id:4f69d6f78a245b10",
      "user_agent:luci-scheduler"
    ],
    "updated_ts": "1603387873967739",
    "url": "https://ci.chromium.org/b/8865725716375245120",
    "utcnow_ts": "1603387874790471"
  }
}
[17:31:14.799] Invocation finished in 1h36m6.685720871s with status SUCCEEDED