1. All projects
  2. infra
  3. Build From Tarball
  4. 9052782449025982416
Status: FAILED
Triggered by: chromium-tarball-builder@chops-service-accounts.iam.gserviceaccount.com
Duration: 49 minutes
Actions:

Definition (rev ef1333c7bf2cf95d15a0ce92acf83d24bcd6c5ac) 

buildbucket: <
  server: "cr-buildbucket.appspot.com"
  bucket: "luci.infra.cron"
  builder: "Build From Tarball"
>

Incoming triggers

  • publish_tarball/0 (5 years ago by chromium-tarball-builder@chops-service-accounts.iam.gserviceaccount.com)

Incoming properties

{
  "version": "81.0.4044.34"
}

Incoming tags

  • parent_buildername:publish_tarball
  • user_agent:recipe

Debug log (UTC)

[22:48:28.576] New invocation is queued and will start shortly
[22:48:28.576] Triggered by user:chromium-tarball-builder@chops-service-accounts.iam.gserviceaccount.com
[22:48:29.928] Starting the invocation (attempt 1)
[22:48:30.027] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[22:48:30.027] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[22:48:30.027] Buildbucket request:
{
  "bucket": "luci.infra.cron",
  "client_operation_id": "9052782449025982416",
  "parameters_json": "{\"builder_name\":\"Build From Tarball\",\"properties\":{\"$recipe_engine/scheduler\":{\"hostname\":\"luci-scheduler.appspot.com\",\"triggers\":[{\"buildbucket\":{\"properties\":{\"version\":\"81.0.4044.34\"},\"tags\":[\"parent_buildername:publish_tarball\",\"user_agent:recipe\"]},\"id\":\"3a4fdada-e622-4434-9d6c-2787fb2a3911\",\"title\":\"publish_tarball/0\"}]},\"version\":\"81.0.4044.34\"}}",
  "pubsub_callback": {
    "auth_token": "...",
    "topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
  },
  "tags": [
    "builder:Build From Tarball",
    "scheduler_invocation_id:9052782449025982416",
    "scheduler_job_id:infra/Build From Tarball",
    "user_agent:luci-scheduler",
    "parent_buildername:publish_tarball",
    "user_agent:recipe"
  ]
}
[22:48:30.493] Buildbucket response:
{
  "build": {
    "bucket": "luci.infra.cron",
    "canary_preference": "PROD",
    "created_by": "project:infra",
    "created_ts": "1582757310126718",
    "id": "8887352386735663168",
    "parameters_json": "{\"builder_name\": \"Build From Tarball\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"buildbucket\": {\"properties\": {\"version\": \"81.0.4044.34\"}, \"tags\": [\"parent_buildername:publish_tarball\", \"user_agent:recipe\"]}, \"id\": \"3a4fdada-e622-4434-9d6c-2787fb2a3911\", \"title\": \"publish_tarball/0\"}]}, \"version\": \"81.0.4044.34\"}}",
    "project": "infra",
    "result_details_json": "{\"properties\": {}}",
    "service_account": "chromium-tarball-builder@chops-service-accounts.iam.gserviceaccount.com",
    "status": "SCHEDULED",
    "status_changed_ts": "1582757310316039",
    "tags": [
      "builder:Build From Tarball",
      "parent_buildername:publish_tarball",
      "scheduler_invocation_id:9052782449025982416",
      "scheduler_job_id:infra/Build From Tarball",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/infra/buildbucket/cr-buildbucket.appspot.com/8887352386735663168/+/annotations",
      "swarming_tag:luci_project:infra",
      "swarming_tag:recipe_name:build_from_tarball",
      "swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/infra/infra",
      "swarming_task_id:",
      "user_agent:luci-scheduler",
      "user_agent:recipe"
    ],
    "updated_ts": "1582757310316136",
    "url": "https://ci.chromium.org/b/8887352386735663168",
    "utcnow_ts": "1582757310486187"
  }
}
[22:48:30.493] Task URL: https://ci.chromium.org/b/8887352386735663168
[22:48:30.493] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:2:0) after 1m0s
[22:49:30.521] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:2:0)
[22:49:30.521] Timer tick, asking Buildbucket for the build status
[22:49:30.650] Build 8887352386735663168: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[22:49:30.650] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:3:0) after 1m0s
[22:50:30.693] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:3:0)
[22:50:30.693] Timer tick, asking Buildbucket for the build status
[22:50:31.101] Build 8887352386735663168: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[22:50:31.101] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:4:0) after 1m0s
[22:51:31.246] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:4:0)
[22:51:31.246] Timer tick, asking Buildbucket for the build status
[22:51:31.466] Build 8887352386735663168: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[22:51:31.466] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:5:0) after 1m0s
[22:52:31.566] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:5:0)
[22:52:31.566] Timer tick, asking Buildbucket for the build status
[22:52:31.919] Build 8887352386735663168: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[22:52:31.919] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:6:0) after 1m0s
[22:52:48.795] Received PubSub notification, asking Buildbucket for the build status
[22:52:49.001] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:53:31.942] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:6:0)
[22:53:31.942] Timer tick, asking Buildbucket for the build status
[22:53:32.271] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:53:32.271] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:8:0) after 1m0s
[22:54:32.378] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:8:0)
[22:54:32.379] Timer tick, asking Buildbucket for the build status
[22:54:32.594] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:54:32.594] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:9:0) after 1m0s
[22:55:32.615] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:9:0)
[22:55:32.615] Timer tick, asking Buildbucket for the build status
[22:55:33.002] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:55:33.002] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:10:0) after 1m0s
[22:56:33.063] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:10:0)
[22:56:33.063] Timer tick, asking Buildbucket for the build status
[22:56:33.308] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:56:33.309] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:11:0) after 1m0s
[22:57:33.339] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:11:0)
[22:57:33.339] Timer tick, asking Buildbucket for the build status
[22:57:33.493] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:57:33.493] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:12:0) after 1m0s
[22:58:33.478] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:12:0)
[22:58:33.478] Timer tick, asking Buildbucket for the build status
[22:58:33.598] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:58:33.598] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:13:0) after 1m0s
[22:59:33.689] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:13:0)
[22:59:33.689] Timer tick, asking Buildbucket for the build status
[22:59:34.398] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:59:34.398] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:14:0) after 1m0s
[23:00:34.566] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:14:0)
[23:00:34.566] Timer tick, asking Buildbucket for the build status
[23:00:35.996] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:00:35.996] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:15:0) after 1m0s
[23:01:36.054] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:15:0)
[23:01:36.054] Timer tick, asking Buildbucket for the build status
[23:01:36.166] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:01:36.166] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:16:0) after 1m0s
[23:02:36.244] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:16:0)
[23:02:36.244] Timer tick, asking Buildbucket for the build status
[23:02:36.832] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:02:36.832] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:17:0) after 1m0s
[23:03:36.919] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:17:0)
[23:03:36.919] Timer tick, asking Buildbucket for the build status
[23:03:37.030] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:03:37.030] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:18:0) after 1m0s
[23:04:37.049] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:18:0)
[23:04:37.049] Timer tick, asking Buildbucket for the build status
[23:04:37.392] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:04:37.392] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:19:0) after 1m0s
[23:05:37.398] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:19:0)
[23:05:37.398] Timer tick, asking Buildbucket for the build status
[23:05:37.551] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:05:37.551] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:20:0) after 1m0s
[23:06:37.609] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:20:0)
[23:06:37.609] Timer tick, asking Buildbucket for the build status
[23:06:38.797] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:06:38.797] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:21:0) after 1m0s
[23:07:38.834] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:21:0)
[23:07:38.834] Timer tick, asking Buildbucket for the build status
[23:07:38.981] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:07:38.981] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:22:0) after 1m0s
[23:08:38.999] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:22:0)
[23:08:38.999] Timer tick, asking Buildbucket for the build status
[23:08:39.141] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:08:39.141] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:23:0) after 1m0s
[23:09:39.215] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:23:0)
[23:09:39.215] Timer tick, asking Buildbucket for the build status
[23:09:39.412] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:09:39.412] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:24:0) after 1m0s
[23:10:39.404] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:24:0)
[23:10:39.404] Timer tick, asking Buildbucket for the build status
[23:10:39.552] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:10:39.552] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:25:0) after 1m0s
[23:11:39.608] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:25:0)
[23:11:39.608] Timer tick, asking Buildbucket for the build status
[23:11:39.734] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:11:39.734] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:26:0) after 1m0s
[23:12:39.769] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:26:0)
[23:12:39.769] Timer tick, asking Buildbucket for the build status
[23:12:39.894] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:12:39.894] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:27:0) after 1m0s
[23:13:39.926] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:27:0)
[23:13:39.926] Timer tick, asking Buildbucket for the build status
[23:13:40.123] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:13:40.123] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:28:0) after 1m0s
[23:14:40.331] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:28:0)
[23:14:40.331] Timer tick, asking Buildbucket for the build status
[23:14:40.580] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:14:40.602] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:29:0) after 1m0s
[23:15:40.771] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:29:0)
[23:15:40.771] Timer tick, asking Buildbucket for the build status
[23:15:40.855] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:15:40.855] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:30:0) after 1m0s
[23:16:41.134] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:30:0)
[23:16:41.134] Timer tick, asking Buildbucket for the build status
[23:16:41.484] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:16:41.484] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:31:0) after 1m0s
[23:17:41.511] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:31:0)
[23:17:41.511] Timer tick, asking Buildbucket for the build status
[23:17:41.612] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:17:41.612] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:32:0) after 1m0s
[23:18:41.749] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:32:0)
[23:18:41.749] Timer tick, asking Buildbucket for the build status
[23:18:41.964] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:18:41.964] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:33:0) after 1m0s
[23:19:42.093] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:33:0)
[23:19:42.093] Timer tick, asking Buildbucket for the build status
[23:19:42.409] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:19:42.409] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:34:0) after 1m0s
[23:20:42.472] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:34:0)
[23:20:42.472] Timer tick, asking Buildbucket for the build status
[23:20:42.630] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:20:42.630] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:35:0) after 1m0s
[23:21:42.661] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:35:0)
[23:21:42.661] Timer tick, asking Buildbucket for the build status
[23:21:42.752] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:21:42.752] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:36:0) after 1m0s
[23:22:42.822] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:36:0)
[23:22:42.822] Timer tick, asking Buildbucket for the build status
[23:22:42.946] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:22:42.946] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:37:0) after 1m0s
[23:23:43.083] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:37:0)
[23:23:43.083] Timer tick, asking Buildbucket for the build status
[23:23:43.370] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:23:43.370] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:38:0) after 1m0s
[23:24:43.402] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:38:0)
[23:24:43.402] Timer tick, asking Buildbucket for the build status
[23:24:43.505] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:24:43.505] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:39:0) after 1m0s
[23:25:43.557] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:39:0)
[23:25:43.557] Timer tick, asking Buildbucket for the build status
[23:25:43.666] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:25:43.666] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:40:0) after 1m0s
[23:26:43.730] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:40:0)
[23:26:43.730] Timer tick, asking Buildbucket for the build status
[23:26:43.833] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:26:43.833] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:41:0) after 1m0s
[23:27:43.988] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:41:0)
[23:27:43.988] Timer tick, asking Buildbucket for the build status
[23:27:44.235] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:27:44.235] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:42:0) after 1m0s
[23:28:44.490] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:42:0)
[23:28:44.490] Timer tick, asking Buildbucket for the build status
[23:28:44.819] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:28:44.819] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:43:0) after 1m0s
[23:29:44.952] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:43:0)
[23:29:44.952] Timer tick, asking Buildbucket for the build status
[23:29:45.087] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:29:45.087] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:44:0) after 1m0s
[23:30:45.312] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:44:0)
[23:30:45.312] Timer tick, asking Buildbucket for the build status
[23:30:45.601] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:30:45.601] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:45:0) after 1m0s
[23:31:45.794] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:45:0)
[23:31:45.794] Timer tick, asking Buildbucket for the build status
[23:31:45.900] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:31:45.900] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:46:0) after 1m0s
[23:32:45.952] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:46:0)
[23:32:45.952] Timer tick, asking Buildbucket for the build status
[23:32:46.252] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:32:46.252] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:47:0) after 1m0s
[23:33:46.343] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:47:0)
[23:33:46.343] Timer tick, asking Buildbucket for the build status
[23:33:46.500] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:33:46.500] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:48:0) after 1m0s
[23:34:46.531] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:48:0)
[23:34:46.531] Timer tick, asking Buildbucket for the build status
[23:34:46.715] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:34:46.715] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:49:0) after 1m0s
[23:35:46.945] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:49:0)
[23:35:46.945] Timer tick, asking Buildbucket for the build status
[23:35:47.252] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:35:47.252] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:50:0) after 1m0s
[23:36:47.308] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:50:0)
[23:36:47.308] Timer tick, asking Buildbucket for the build status
[23:36:47.551] Build 8887352386735663168: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:36:47.552] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9052782449025982416:51:0) after 1m0s
[23:37:40.293] Received PubSub notification, asking Buildbucket for the build status
[23:37:40.372] Build 8887352386735663168: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[23:37:40.372] Buildbucket build:
{
  "build": {
    "bucket": "luci.infra.cron",
    "canary_preference": "PROD",
    "completed_ts": "1582760259759299",
    "created_by": "project:infra",
    "created_ts": "1582757310126718",
    "failure_reason": "BUILD_FAILURE",
    "id": "8887352386735663168",
    "parameters_json": "{\"builder_name\": \"Build From Tarball\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"buildbucket\": {\"properties\": {\"version\": \"81.0.4044.34\"}, \"tags\": [\"parent_buildername:publish_tarball\", \"user_agent:recipe\"]}, \"id\": \"3a4fdada-e622-4434-9d6c-2787fb2a3911\", \"title\": \"publish_tarball/0\"}]}, \"version\": \"81.0.4044.34\"}}",
    "project": "infra",
    "result": "FAILURE",
    "result_details_json": "{\"error\": {\"message\": \"Step('Build chrome.') (retcode: 1)\"}, \"properties\": {\"$gatekeeper\": {\"group\": \"chromium.infra.cron\"}, \"$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\": [{\"buildbucket\": {\"properties\": {\"version\": \"81.0.4044.34\"}, \"tags\": [\"parent_buildername:publish_tarball\", \"user_agent:recipe\"]}, \"id\": \"3a4fdada-e622-4434-9d6c-2787fb2a3911\", \"title\": \"publish_tarball/0\"}]}, \"bot_id\": \"luci-infra-cron-xenial-large-0-i1qv\", \"buildername\": \"Build From Tarball\", \"path_config\": \"generic\", \"recipe\": \"build_from_tarball\", \"version\": \"81.0.4044.34\"}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"git\", \"vpython\"], \"cores\": [\"32\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"luci-infra-cron-xenial-large-0-i1qv\"], \"image\": [\"chrome-xenial-20012600-8e1a7e485b7\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"n1-standard-32\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-16.04\"], \"pool\": [\"luci.infra.cron\"], \"python\": [\"2.7.12\"], \"server_version\": [\"4838-b69615e\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-east\", \"us-east1\", \"us-east1-b\"]}}, \"ui\": {\"info\": \"Step('Build chrome.') (retcode: 1)\"}}",
    "service_account": "chromium-tarball-builder@chops-service-accounts.iam.gserviceaccount.com",
    "started_ts": "1582757567597912",
    "status": "COMPLETED",
    "status_changed_ts": "1582757568080310",
    "tags": [
      "builder:Build From Tarball",
      "parent_buildername:publish_tarball",
      "scheduler_invocation_id:9052782449025982416",
      "scheduler_job_id:infra/Build From Tarball",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/infra/buildbucket/cr-buildbucket.appspot.com/8887352386735663168/+/annotations",
      "swarming_tag:luci_project:infra",
      "swarming_tag:os:Linux",
      "swarming_tag:recipe_name:build_from_tarball",
      "swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/infra/infra",
      "swarming_task_id:4a9c8178ff687510",
      "user_agent:luci-scheduler",
      "user_agent:recipe"
    ],
    "updated_ts": "1582760259979938",
    "url": "https://ci.chromium.org/b/8887352386735663168",
    "utcnow_ts": "1582760260364372"
  }
}
[23:37:40.372] Invocation finished in 49m11.813666059s with status FAILED