Status: SUCCEEDED
Triggered by: -
Duration: 8 hours
Actions:

Definition (rev 87e0f3400b0aac78b81573f56efb8257c68089b2)

buildbucket: <
  server: "cr-buildbucket.appspot.com"
  bucket: "ci"
  builder: "win"
>

Incoming triggers

Incoming properties

{
  "branch": "refs/heads/main",
  "repository": "https://r8.googlesource.com/r8",
  "revision": "391eb0d5c84b763122f7c173d96606345d5dca7c"
}

Incoming tags

  • buildset:commit/gitiles/r8.googlesource.com/r8/+/391eb0d5c84b763122f7c173d96606345d5dca7c
  • gitiles_ref:refs/heads/main

Debug log (UTC)

[11:23:59.728] New invocation is queued and will start shortly
[11:24:01.442] Starting the invocation (attempt 1)
[11:24:01.478] Popped buildset tag "buildset:commit/gitiles/r8.googlesource.com/r8/+/391eb0d5c84b763122f7c173d96606345d5dca7c"
[11:24:01.478] Popped gitiles commit info from properties and tags
[11:24:01.478] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[11:24:01.478] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[11:24:01.478] Buildbucket request:
{
  "requestId": "8903884100066510176",
  "builder": {
    "project": "r8",
    "bucket": "ci",
    "builder": "win"
  },
  "properties": {
      "$recipe_engine/scheduler": {
            "hostname": "luci-scheduler.appspot.com",
            "invocation": "8903884100066510176",
            "job": "r8/win",
            "triggers": [
                  {
                        "gitiles": {
                              "ref": "refs/heads/main",
                              "repo": "https://r8.googlesource.com/r8",
                              "revision": "391eb0d5c84b763122f7c173d96606345d5dca7c"
                            },
                        "id": "https://r8.googlesource.com/r8/+/refs/heads/main@391eb0d5c84b763122f7c173d96606345d5dca7c",
                        "title": "391eb0d5c84b763122f7c173d96606345d5dca7c",
                        "url": "https://r8.googlesource.com/r8/+/391eb0d5c84b763122f7c173d96606345d5dca7c"
                      }
                ]
          }
    },
  "gitilesCommit": {
    "host": "r8.googlesource.com",
    "project": "r8",
    "id": "391eb0d5c84b763122f7c173d96606345d5dca7c",
    "ref": "refs/heads/main"
  },
  "tags": [
    {
      "key": "scheduler_invocation_id",
      "value": "8903884100066510176"
    },
    {
      "key": "scheduler_job_id",
      "value": "r8/win"
    },
    {
      "key": "user_agent",
      "value": "luci-scheduler"
    }
  ],
  "notify": {
    "pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
  }
}
[11:24:02.447] Scheduled build:
{
  "id": "8738454037441489649",
  "builder": {
    "project": "r8",
    "bucket": "ci",
    "builder": "win"
  },
  "number": 157,
  "createdBy": "project:r8",
  "createTime": "2024-08-27T11:24:01.603389063Z",
  "updateTime": "2024-08-27T11:24:01.603389063Z",
  "status": "SCHEDULED",
  "input": {
    "gitilesCommit": {
      "host": "r8.googlesource.com",
      "project": "r8",
      "id": "391eb0d5c84b763122f7c173d96606345d5dca7c",
      "ref": "refs/heads/main"
    }
  }
}
[11:24:02.447] Task URL: https://cr-buildbucket.appspot.com/build/8738454037441489649
[11:24:02.447] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:2:0) after 2m3s
[11:24:03.087] Received PubSub notification, asking Buildbucket for the build status
[11:24:03.111] Build status: SCHEDULED
[11:26:05.562] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:2:0)
[11:26:05.586] Build status: SCHEDULED
[11:26:05.586] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:4:0) after 7m12s
[11:33:17.776] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:4:0)
[11:33:17.801] Build status: SCHEDULED
[11:33:17.802] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:5:0) after 1m2s
[11:34:19.927] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:5:0)
[11:34:19.972] Build status: SCHEDULED
[11:34:19.972] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:6:0) after 5m30s
[11:39:49.968] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:6:0)
[11:39:50.000] Build status: SCHEDULED
[11:39:50.000] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:7:0) after 6m59s
[11:46:49.015] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:7:0)
[11:46:49.034] Build status: SCHEDULED
[11:46:49.034] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:8:0) after 2m47s
[11:49:36.182] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:8:0)
[11:49:36.199] Build status: SCHEDULED
[11:49:36.199] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:9:0) after 8m36s
[11:58:12.267] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:9:0)
[11:58:12.315] Build status: SCHEDULED
[11:58:12.315] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:10:0) after 6m20s
[12:04:32.340] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:10:0)
[12:04:32.367] Build status: SCHEDULED
[12:04:32.367] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:11:0) after 7m55s
[12:12:27.430] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:11:0)
[12:12:27.463] Build status: SCHEDULED
[12:12:27.463] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:12:0) after 6m45s
[12:19:12.504] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:12:0)
[12:19:12.519] Build status: SCHEDULED
[12:19:12.519] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:13:0) after 5m50s
[12:25:02.557] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:13:0)
[12:25:02.576] Build status: SCHEDULED
[12:25:02.576] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:14:0) after 3m27s
[12:28:29.642] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:14:0)
[12:28:29.675] Build status: SCHEDULED
[12:28:29.675] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:15:0) after 2m15s
[12:30:44.755] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:15:0)
[12:30:44.774] Build status: SCHEDULED
[12:30:44.774] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:16:0) after 7m56s
[12:38:40.788] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:16:0)
[12:38:40.805] Build status: SCHEDULED
[12:38:40.805] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:17:0) after 4m7s
[12:42:48.051] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:17:0)
[12:42:48.123] Build status: SCHEDULED
[12:42:48.123] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:18:0) after 7m3s
[12:49:51.214] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:18:0)
[12:49:51.231] Build status: SCHEDULED
[12:49:51.231] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:19:0) after 1m14s
[12:51:05.567] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:19:0)
[12:51:05.638] Build status: SCHEDULED
[12:51:05.638] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:20:0) after 8m42s
[12:59:47.655] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:20:0)
[12:59:47.674] Build status: SCHEDULED
[12:59:47.674] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:21:0) after 2m50s
[13:02:37.705] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:21:0)
[13:02:37.739] Build status: SCHEDULED
[13:02:37.739] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:22:0) after 1m43s
[13:04:20.755] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:22:0)
[13:04:20.772] Build status: SCHEDULED
[13:04:20.772] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:23:0) after 1m31s
[13:05:52.068] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:23:0)
[13:05:52.088] Build status: SCHEDULED
[13:05:52.088] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:24:0) after 9m12s
[13:15:04.106] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:24:0)
[13:15:04.192] Build status: SCHEDULED
[13:15:04.192] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:25:0) after 3m0s
[13:18:04.481] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:25:0)
[13:18:04.500] Build status: SCHEDULED
[13:18:04.500] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:26:0) after 4m59s
[13:23:03.684] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:26:0)
[13:23:03.744] Build status: SCHEDULED
[13:23:03.744] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:27:0) after 3m54s
[13:26:57.764] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:27:0)
[13:26:57.781] Build status: SCHEDULED
[13:26:57.781] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:28:0) after 8m44s
[13:35:41.800] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:28:0)
[13:35:41.817] Build status: SCHEDULED
[13:35:41.817] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:29:0) after 7m48s
[13:43:29.863] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:29:0)
[13:43:29.885] Build status: SCHEDULED
[13:43:29.885] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:30:0) after 6m38s
[13:50:07.952] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:30:0)
[13:50:07.971] Build status: SCHEDULED
[13:50:07.971] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:31:0) after 7m10s
[13:57:17.987] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:31:0)
[13:57:18.134] Build status: SCHEDULED
[13:57:18.135] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:32:0) after 4m19s
[14:00:43.817] Received PubSub notification, asking Buildbucket for the build status
[14:00:43.844] Build status: STARTED
[14:01:37.152] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:32:0)
[14:01:37.176] Build status: STARTED
[14:01:37.176] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:34:0) after 7m18s
[14:08:55.195] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:34:0)
[14:08:55.213] Build status: STARTED
[14:08:55.213] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:35:0) after 5m25s
[14:14:20.238] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:35:0)
[14:14:20.331] Build status: STARTED
[14:14:20.331] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:36:0) after 1m22s
[14:15:42.387] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:36:0)
[14:15:42.406] Build status: STARTED
[14:15:42.406] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:37:0) after 2m13s
[14:17:55.522] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:37:0)
[14:17:55.552] Build status: STARTED
[14:17:55.552] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:38:0) after 1m8s
[14:19:03.574] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:38:0)
[14:19:03.595] Build status: STARTED
[14:19:03.595] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:39:0) after 4m29s
[14:23:32.637] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:39:0)
[14:23:32.660] Build status: STARTED
[14:23:32.661] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:40:0) after 4m24s
[14:27:56.678] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:40:0)
[14:27:56.698] Build status: STARTED
[14:27:56.698] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:41:0) after 8m10s
[14:36:06.712] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:41:0)
[14:36:06.730] Build status: STARTED
[14:36:06.730] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:42:0) after 1m41s
[14:37:47.913] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:42:0)
[14:37:47.949] Build status: STARTED
[14:37:47.949] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:43:0) after 5m44s
[14:43:31.965] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:43:0)
[14:43:31.988] Build status: STARTED
[14:43:31.988] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:44:0) after 1m13s
[14:44:45.005] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:44:0)
[14:44:45.026] Build status: STARTED
[14:44:45.026] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:45:0) after 6m16s
[14:51:01.044] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:45:0)
[14:51:01.075] Build status: STARTED
[14:51:01.075] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:46:0) after 7m34s
[14:58:35.312] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:46:0)
[14:58:35.345] Build status: STARTED
[14:58:35.345] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:47:0) after 8m7s
[15:06:42.455] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:47:0)
[15:06:42.535] Build status: STARTED
[15:06:42.535] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:48:0) after 3m45s
[15:10:27.552] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:48:0)
[15:10:27.572] Build status: STARTED
[15:10:27.572] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:49:0) after 6m6s
[15:16:33.727] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:49:0)
[15:16:33.758] Build status: STARTED
[15:16:33.758] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:50:0) after 7m9s
[15:23:42.779] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:50:0)
[15:23:42.888] Build status: STARTED
[15:23:42.888] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:51:0) after 4m55s
[15:28:37.992] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:51:0)
[15:28:38.030] Build status: STARTED
[15:28:38.030] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:52:0) after 2m21s
[15:30:59.055] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:52:0)
[15:30:59.075] Build status: STARTED
[15:30:59.076] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:53:0) after 5m22s
[15:36:21.097] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:53:0)
[15:36:21.124] Build status: STARTED
[15:36:21.124] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:54:0) after 6m57s
[15:43:18.269] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:54:0)
[15:43:18.449] Build status: STARTED
[15:43:18.449] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:55:0) after 8m46s
[15:52:04.532] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:55:0)
[15:52:04.567] Build status: STARTED
[15:52:04.567] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:56:0) after 6m44s
[15:58:48.597] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:56:0)
[15:58:48.647] Build status: STARTED
[15:58:48.647] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:57:0) after 4m23s
[16:03:11.768] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:57:0)
[16:03:11.828] Build status: STARTED
[16:03:11.828] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:58:0) after 1m10s
[16:04:21.845] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:58:0)
[16:04:21.864] Build status: STARTED
[16:04:21.864] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:59:0) after 8m53s
[16:13:14.880] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:59:0)
[16:13:14.923] Build status: STARTED
[16:13:14.923] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:60:0) after 7m52s
[16:21:07.020] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:60:0)
[16:21:07.056] Build status: STARTED
[16:21:07.056] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:61:0) after 6m3s
[16:27:10.084] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:61:0)
[16:27:10.119] Build status: STARTED
[16:27:10.119] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:62:0) after 3m52s
[16:31:02.141] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:62:0)
[16:31:02.186] Build status: STARTED
[16:31:02.186] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:63:0) after 4m56s
[16:35:58.205] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:63:0)
[16:35:58.237] Build status: STARTED
[16:35:58.237] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:64:0) after 2m11s
[16:38:09.351] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:64:0)
[16:38:09.421] Build status: STARTED
[16:38:09.421] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:65:0) after 1m41s
[16:39:50.514] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:65:0)
[16:39:50.543] Build status: STARTED
[16:39:50.543] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:66:0) after 2m31s
[16:42:21.554] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:66:0)
[16:42:21.598] Build status: STARTED
[16:42:21.598] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:67:0) after 9m34s
[16:51:55.576] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:67:0)
[16:51:55.600] Build status: STARTED
[16:51:55.600] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:68:0) after 4m22s
[16:56:17.616] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:68:0)
[16:56:17.641] Build status: STARTED
[16:56:17.641] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:69:0) after 4m41s
[17:00:58.692] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:69:0)
[17:00:58.710] Build status: STARTED
[17:00:58.710] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:70:0) after 3m51s
[17:04:49.753] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:70:0)
[17:04:49.779] Build status: STARTED
[17:04:49.779] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:71:0) after 6m35s
[17:11:24.797] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:71:0)
[17:11:24.815] Build status: STARTED
[17:11:24.815] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:72:0) after 8m14s
[17:19:38.881] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:72:0)
[17:19:38.901] Build status: STARTED
[17:19:38.901] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:73:0) after 2m10s
[17:21:48.929] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:73:0)
[17:21:48.955] Build status: STARTED
[17:21:48.955] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:74:0) after 9m32s
[17:31:20.955] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:74:0)
[17:31:20.996] Build status: STARTED
[17:31:20.997] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:75:0) after 4m30s
[17:35:51.177] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:75:0)
[17:35:51.252] Build status: STARTED
[17:35:51.252] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:76:0) after 2m46s
[17:38:37.435] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:76:0)
[17:38:37.461] Build status: STARTED
[17:38:37.461] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:77:0) after 5m18s
[17:43:55.477] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:77:0)
[17:43:55.505] Build status: STARTED
[17:43:55.506] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:78:0) after 8m0s
[17:51:55.575] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:78:0)
[17:51:55.627] Build status: STARTED
[17:51:55.627] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:79:0) after 6m36s
[17:58:31.678] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:79:0)
[17:58:31.731] Build status: STARTED
[17:58:31.731] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:80:0) after 8m32s
[18:07:03.769] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:80:0)
[18:07:03.822] Build status: STARTED
[18:07:03.822] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:81:0) after 6m29s
[18:13:32.892] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:81:0)
[18:13:32.924] Build status: STARTED
[18:13:32.924] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:82:0) after 3m56s
[18:17:28.990] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:82:0)
[18:17:29.017] Build status: STARTED
[18:17:29.017] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:83:0) after 9m57s
[18:27:26.079] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:83:0)
[18:27:26.094] Build status: STARTED
[18:27:26.094] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:84:0) after 7m36s
[18:35:02.114] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:84:0)
[18:35:02.164] Build status: STARTED
[18:35:02.165] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:85:0) after 6m21s
[18:41:23.240] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:85:0)
[18:41:23.322] Build status: STARTED
[18:41:23.322] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:86:0) after 2m25s
[18:43:48.342] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:86:0)
[18:43:48.370] Build status: STARTED
[18:43:48.370] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:87:0) after 8m36s
[18:52:24.361] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:87:0)
[18:52:24.393] Build status: STARTED
[18:52:24.393] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:88:0) after 8m27s
[19:00:51.443] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:88:0)
[19:00:51.526] Build status: STARTED
[19:00:51.526] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:89:0) after 1m29s
[19:02:20.587] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:89:0)
[19:02:20.610] Build status: STARTED
[19:02:20.610] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:90:0) after 3m28s
[19:05:48.824] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:90:0)
[19:05:48.911] Build status: STARTED
[19:05:48.912] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:91:0) after 8m40s
[19:14:28.979] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:91:0)
[19:14:29.007] Build status: STARTED
[19:14:29.007] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:92:0) after 4m1s
[19:18:30.023] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:92:0)
[19:18:30.053] Build status: STARTED
[19:18:30.053] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:93:0) after 3m33s
[19:22:03.070] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:93:0)
[19:22:03.103] Build status: STARTED
[19:22:03.103] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:94:0) after 3m57s
[19:26:00.209] Handling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:94:0)
[19:26:00.229] Build status: STARTED
[19:26:00.229] Scheduling timer "check-buildbucket-build-status" (r8/win:8903884100066510176:95:0) after 7m40s
[19:32:53.247] Received PubSub notification, asking Buildbucket for the build status
[19:32:53.404] Build:
{
  "id": "8738454037441489649",
  "builder": {
    "project": "r8",
    "bucket": "ci",
    "builder": "win"
  },
  "number": 157,
  "createdBy": "project:r8",
  "createTime": "2024-08-27T11:24:01.603389063Z",
  "startTime": "2024-08-27T14:00:43.547167914Z",
  "endTime": "2024-08-27T19:32:52.968906771Z",
  "updateTime": "2024-08-27T19:32:52.968906771Z",
  "status": "SUCCESS",
  "input": {
    "gitilesCommit": {
      "host": "r8.googlesource.com",
      "project": "r8",
      "id": "391eb0d5c84b763122f7c173d96606345d5dca7c",
      "ref": "refs/heads/main"
    }
  }
}
[19:32:53.404] Invocation finished in 8h8m53.687951652s with status SUCCEEDED