[07:24:10.503] New invocation is queued and will start shortly
[07:24:11.597] Starting the invocation (attempt 1)
[07:24:11.629] Popped buildset tag "buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/d8f63bbc8e20a68e764852a15d67a06fcd14c5bd"
[07:24:11.629] Popped gitiles commit info from properties and tags
[07:24:11.629] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[07:24:11.629] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[07:24:11.629] Buildbucket request:
{
"requestId": "8849812799315226528",
"builder": {
"project": "fuchsia",
"bucket": "prod",
"builder": "clang-prod-unbounded-trigger"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8849812799315226528",
"job": "fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "98449cb8dd7f79a9eade62b5ecb1fa8c614c3a0e"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@98449cb8dd7f79a9eade62b5ecb1fa8c614c3a0e",
"title": "98449cb8dd7f79a9eade62b5ecb1fa8c614c3a0e",
"url": "https://llvm.googlesource.com/llvm-project/+/98449cb8dd7f79a9eade62b5ecb1fa8c614c3a0e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "13cae27e9e99ab2ca865e9670c9aaa6106d87cb7"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@13cae27e9e99ab2ca865e9670c9aaa6106d87cb7",
"title": "13cae27e9e99ab2ca865e9670c9aaa6106d87cb7",
"url": "https://llvm.googlesource.com/llvm-project/+/13cae27e9e99ab2ca865e9670c9aaa6106d87cb7"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "72a3cd9e54f16d87f47bc984672999a9b67cd4f4"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@72a3cd9e54f16d87f47bc984672999a9b67cd4f4",
"title": "72a3cd9e54f16d87f47bc984672999a9b67cd4f4",
"url": "https://llvm.googlesource.com/llvm-project/+/72a3cd9e54f16d87f47bc984672999a9b67cd4f4"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "ad2bf491badb3c9d58591cf271aff94384e2ede6"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@ad2bf491badb3c9d58591cf271aff94384e2ede6",
"title": "ad2bf491badb3c9d58591cf271aff94384e2ede6",
"url": "https://llvm.googlesource.com/llvm-project/+/ad2bf491badb3c9d58591cf271aff94384e2ede6"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "bd810585154b7f759689f576e95033a5e5f79593"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@bd810585154b7f759689f576e95033a5e5f79593",
"title": "bd810585154b7f759689f576e95033a5e5f79593",
"url": "https://llvm.googlesource.com/llvm-project/+/bd810585154b7f759689f576e95033a5e5f79593"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "6279043b5b2613282d68818485b10e4038a511a7"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@6279043b5b2613282d68818485b10e4038a511a7",
"title": "6279043b5b2613282d68818485b10e4038a511a7",
"url": "https://llvm.googlesource.com/llvm-project/+/6279043b5b2613282d68818485b10e4038a511a7"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "982f736c852c06e8ad58300980c8a7b4a79045ff"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@982f736c852c06e8ad58300980c8a7b4a79045ff",
"title": "982f736c852c06e8ad58300980c8a7b4a79045ff",
"url": "https://llvm.googlesource.com/llvm-project/+/982f736c852c06e8ad58300980c8a7b4a79045ff"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "d8f63bbc8e20a68e764852a15d67a06fcd14c5bd"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@d8f63bbc8e20a68e764852a15d67a06fcd14c5bd",
"title": "d8f63bbc8e20a68e764852a15d67a06fcd14c5bd",
"url": "https://llvm.googlesource.com/llvm-project/+/d8f63bbc8e20a68e764852a15d67a06fcd14c5bd"
}
]
}
},
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "d8f63bbc8e20a68e764852a15d67a06fcd14c5bd",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8849812799315226528"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[07:24:12.070] Scheduled build:
{
"id": "8684382737393039185",
"builder": {
"project": "fuchsia",
"bucket": "prod",
"builder": "clang-prod-unbounded-trigger"
},
"createdBy": "project:fuchsia",
"createTime": "2026-04-16T07:24:11.714326623Z",
"updateTime": "2026-04-16T07:24:11.714326623Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "d8f63bbc8e20a68e764852a15d67a06fcd14c5bd",
"ref": "refs/heads/main"
}
}
}
[07:24:12.070] Task URL: https://cr-buildbucket.appspot.com/build/8684382737393039185
[07:24:12.071] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:2:0) after 1m30s
[07:24:12.396] Received PubSub notification, asking Buildbucket for the build status
[07:24:12.431] Build status: SCHEDULED
[07:24:15.695] Received PubSub notification, asking Buildbucket for the build status
[07:24:15.715] Build status: STARTED
[07:25:42.083] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:2:0)
[07:25:42.102] Build status: STARTED
[07:25:42.102] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:5:0) after 8m44s
[07:34:26.120] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:5:0)
[07:34:26.146] Build status: STARTED
[07:34:26.146] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:6:0) after 3m22s
[07:37:48.125] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:6:0)
[07:37:48.141] Build status: STARTED
[07:37:48.142] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:7:0) after 5m47s
[07:43:35.191] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:7:0)
[07:43:35.210] Build status: STARTED
[07:43:35.210] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:8:0) after 6m13s
[07:49:48.333] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:8:0)
[07:49:48.348] Build status: STARTED
[07:49:48.348] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:9:0) after 9m31s
[07:59:19.362] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:9:0)
[07:59:19.383] Build status: STARTED
[07:59:19.383] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:10:0) after 5m59s
[08:05:18.449] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:10:0)
[08:05:18.480] Build status: STARTED
[08:05:18.480] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:11:0) after 3m43s
[08:09:01.495] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:11:0)
[08:09:01.512] Build status: STARTED
[08:09:01.512] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:12:0) after 5m23s
[08:14:24.581] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:12:0)
[08:14:24.600] Build status: STARTED
[08:14:24.600] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:13:0) after 3m27s
[08:17:51.621] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:13:0)
[08:17:51.678] Build status: STARTED
[08:17:51.678] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:14:0) after 9m0s
[08:26:51.699] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:14:0)
[08:26:51.780] Build status: STARTED
[08:26:51.780] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:15:0) after 3m33s
[08:30:24.797] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:15:0)
[08:30:24.814] Build status: STARTED
[08:30:24.814] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:16:0) after 2m50s
[08:33:14.831] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:16:0)
[08:33:14.852] Build status: STARTED
[08:33:14.852] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:17:0) after 9m39s
[08:42:53.895] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:17:0)
[08:42:53.926] Build status: STARTED
[08:42:53.926] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:18:0) after 1m46s
[08:44:39.939] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:18:0)
[08:44:39.968] Build status: STARTED
[08:44:39.968] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:19:0) after 3m58s
[08:48:38.047] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:19:0)
[08:48:38.068] Build status: STARTED
[08:48:38.068] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:20:0) after 3m25s
[08:52:03.085] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:20:0)
[08:52:03.124] Build status: STARTED
[08:52:03.125] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:21:0) after 8m47s
[09:00:50.148] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:21:0)
[09:00:50.177] Build status: STARTED
[09:00:50.177] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:22:0) after 7m41s
[09:08:31.198] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:22:0)
[09:08:31.219] Build status: STARTED
[09:08:31.219] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:23:0) after 8m3s
[09:16:34.281] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:23:0)
[09:16:34.304] Build status: STARTED
[09:16:34.304] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:24:0) after 7m59s
[09:24:33.324] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:24:0)
[09:24:33.354] Build status: STARTED
[09:24:33.354] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:25:0) after 8m44s
[09:33:17.376] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:25:0)
[09:33:17.401] Build status: STARTED
[09:33:17.401] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:26:0) after 3m21s
[09:36:38.469] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:26:0)
[09:36:38.512] Build status: STARTED
[09:36:38.512] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:27:0) after 2m1s
[09:38:39.532] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:27:0)
[09:38:39.548] Build status: STARTED
[09:38:39.548] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:28:0) after 1m9s
[09:39:48.565] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:28:0)
[09:39:48.585] Build status: STARTED
[09:39:48.585] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:29:0) after 6m42s
[09:46:30.609] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:29:0)
[09:46:30.640] Build status: STARTED
[09:46:30.640] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:30:0) after 4m58s
[09:51:28.710] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:30:0)
[09:51:28.729] Build status: STARTED
[09:51:28.729] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:31:0) after 6m36s
[09:58:04.865] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:31:0)
[09:58:04.882] Build status: STARTED
[09:58:04.882] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:32:0) after 7m37s
[10:05:41.899] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:32:0)
[10:05:41.918] Build status: STARTED
[10:05:41.918] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:33:0) after 8m57s
[10:14:39.020] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:33:0)
[10:14:39.039] Build status: STARTED
[10:14:39.039] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:34:0) after 9m55s
[10:24:34.143] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:34:0)
[10:24:34.161] Build status: STARTED
[10:24:34.161] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-prod-unbounded-trigger-40be1bb5:8849812799315226528:35:0) after 1m50s
[10:26:10.686] Received PubSub notification, asking Buildbucket for the build status
[10:26:10.704] Build:
{
"id": "8684382737393039185",
"builder": {
"project": "fuchsia",
"bucket": "prod",
"builder": "clang-prod-unbounded-trigger"
},
"createdBy": "project:fuchsia",
"createTime": "2026-04-16T07:24:11.714326623Z",
"startTime": "2026-04-16T07:24:15.414613374Z",
"endTime": "2026-04-16T10:26:10.454526280Z",
"updateTime": "2026-04-16T10:26:10.454526280Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "d8f63bbc8e20a68e764852a15d67a06fcd14c5bd",
"ref": "refs/heads/main"
}
}
}
[10:26:10.704] Invocation finished in 3h2m0.206754864s with status SUCCEEDED