[18:20:44.690] New invocation is queued and will start shortly
[18:20:45.760] Starting the invocation (attempt 1)
[18:20:45.793] Popped buildset tag "buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/378f248934d603e3fba9d958d2db997814d057d5"
[18:20:45.793] Popped gitiles commit info from properties and tags
[18:20:45.793] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[18:20:45.793] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[18:20:45.794] Buildbucket request:
{
"requestId": "8875772820880821520",
"builder": {
"project": "fuchsia",
"bucket": "prod",
"builder": "clang-ci-trigger"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8875772820880821520",
"job": "fuchsia/prod-clang-ci-trigger-40be1bb5",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "4cd9c894d1ef27c26a825be5dac2824b7c30659b"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@4cd9c894d1ef27c26a825be5dac2824b7c30659b",
"title": "4cd9c894d1ef27c26a825be5dac2824b7c30659b",
"url": "https://llvm.googlesource.com/llvm-project/+/4cd9c894d1ef27c26a825be5dac2824b7c30659b"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "77f0f812b4195bfde3b8d2ddb4b85f78f41a628f"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@77f0f812b4195bfde3b8d2ddb4b85f78f41a628f",
"title": "77f0f812b4195bfde3b8d2ddb4b85f78f41a628f",
"url": "https://llvm.googlesource.com/llvm-project/+/77f0f812b4195bfde3b8d2ddb4b85f78f41a628f"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "a695d6b9a726d0059d9bf80341ee567c1153286c"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@a695d6b9a726d0059d9bf80341ee567c1153286c",
"title": "a695d6b9a726d0059d9bf80341ee567c1153286c",
"url": "https://llvm.googlesource.com/llvm-project/+/a695d6b9a726d0059d9bf80341ee567c1153286c"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "1aa39690aa73ad227ef1fb94ddb340d462cfea01"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@1aa39690aa73ad227ef1fb94ddb340d462cfea01",
"title": "1aa39690aa73ad227ef1fb94ddb340d462cfea01",
"url": "https://llvm.googlesource.com/llvm-project/+/1aa39690aa73ad227ef1fb94ddb340d462cfea01"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "795b17d0b821e44f89d021dec18e9fdb28930ff6"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@795b17d0b821e44f89d021dec18e9fdb28930ff6",
"title": "795b17d0b821e44f89d021dec18e9fdb28930ff6",
"url": "https://llvm.googlesource.com/llvm-project/+/795b17d0b821e44f89d021dec18e9fdb28930ff6"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "2f75f658b18aed4bbcab391063bceb7ccaf8a6ec"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@2f75f658b18aed4bbcab391063bceb7ccaf8a6ec",
"title": "2f75f658b18aed4bbcab391063bceb7ccaf8a6ec",
"url": "https://llvm.googlesource.com/llvm-project/+/2f75f658b18aed4bbcab391063bceb7ccaf8a6ec"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "8d3dbdb00f8f4b4953a7e2a13906dc3fce635d5d"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@8d3dbdb00f8f4b4953a7e2a13906dc3fce635d5d",
"title": "8d3dbdb00f8f4b4953a7e2a13906dc3fce635d5d",
"url": "https://llvm.googlesource.com/llvm-project/+/8d3dbdb00f8f4b4953a7e2a13906dc3fce635d5d"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "53baee94cce6997fd3b9b4cb6742d2b1172c5f62"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@53baee94cce6997fd3b9b4cb6742d2b1172c5f62",
"title": "53baee94cce6997fd3b9b4cb6742d2b1172c5f62",
"url": "https://llvm.googlesource.com/llvm-project/+/53baee94cce6997fd3b9b4cb6742d2b1172c5f62"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "a0e846277023f1febde523b483dfa51ebaeb38be"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@a0e846277023f1febde523b483dfa51ebaeb38be",
"title": "a0e846277023f1febde523b483dfa51ebaeb38be",
"url": "https://llvm.googlesource.com/llvm-project/+/a0e846277023f1febde523b483dfa51ebaeb38be"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "d66254e7fe21c92e0d39e14fbbb29b1b576e9423"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@d66254e7fe21c92e0d39e14fbbb29b1b576e9423",
"title": "d66254e7fe21c92e0d39e14fbbb29b1b576e9423",
"url": "https://llvm.googlesource.com/llvm-project/+/d66254e7fe21c92e0d39e14fbbb29b1b576e9423"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "994501abe75c2a2d244785c0d0cf177858ac6eaf"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@994501abe75c2a2d244785c0d0cf177858ac6eaf",
"title": "994501abe75c2a2d244785c0d0cf177858ac6eaf",
"url": "https://llvm.googlesource.com/llvm-project/+/994501abe75c2a2d244785c0d0cf177858ac6eaf"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "1e76f012db3ccfaa05e238812e572b5b6d12c17e"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@1e76f012db3ccfaa05e238812e572b5b6d12c17e",
"title": "1e76f012db3ccfaa05e238812e572b5b6d12c17e",
"url": "https://llvm.googlesource.com/llvm-project/+/1e76f012db3ccfaa05e238812e572b5b6d12c17e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "378f248934d603e3fba9d958d2db997814d057d5"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@378f248934d603e3fba9d958d2db997814d057d5",
"title": "378f248934d603e3fba9d958d2db997814d057d5",
"url": "https://llvm.googlesource.com/llvm-project/+/378f248934d603e3fba9d958d2db997814d057d5"
}
]
}
},
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "378f248934d603e3fba9d958d2db997814d057d5",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8875772820880821520"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/prod-clang-ci-trigger-40be1bb5"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[18:20:46.222] Scheduled build:
{
"id": "8710342759007138673",
"builder": {
"project": "fuchsia",
"bucket": "prod",
"builder": "clang-ci-trigger"
},
"createdBy": "project:fuchsia",
"createTime": "2025-07-03T18:20:45.847005007Z",
"updateTime": "2025-07-03T18:20:45.847005007Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "378f248934d603e3fba9d958d2db997814d057d5",
"ref": "refs/heads/main"
}
}
}
[18:20:46.222] Task URL: https://cr-buildbucket.appspot.com/build/8710342759007138673
[18:20:46.222] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:2:0) after 1m16s
[18:20:47.967] Received PubSub notification, asking Buildbucket for the build status
[18:20:48.000] Build status: SCHEDULED
[18:22:02.326] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:2:0)
[18:22:02.345] Build status: SCHEDULED
[18:22:02.345] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:4:0) after 9m31s
[18:31:33.514] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:4:0)
[18:31:33.529] Build status: SCHEDULED
[18:31:33.529] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:5:0) after 6m20s
[18:37:53.790] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:5:0)
[18:37:53.884] Build status: SCHEDULED
[18:37:53.884] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:6:0) after 7m24s
[18:45:18.010] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:6:0)
[18:45:18.047] Build status: SCHEDULED
[18:45:18.047] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:7:0) after 6m38s
[18:51:56.121] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:7:0)
[18:51:56.140] Build status: SCHEDULED
[18:51:56.140] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:8:0) after 6m10s
[18:58:06.230] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:8:0)
[18:58:06.265] Build status: SCHEDULED
[18:58:06.265] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:9:0) after 9m16s
[19:07:22.284] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:9:0)
[19:07:22.311] Build status: SCHEDULED
[19:07:22.311] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:10:0) after 9m32s
[19:16:54.657] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:10:0)
[19:16:54.837] Build status: SCHEDULED
[19:16:54.837] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:11:0) after 3m58s
[19:20:52.866] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:11:0)
[19:20:52.885] Build status: SCHEDULED
[19:20:52.885] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:12:0) after 4m22s
[19:25:15.091] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:12:0)
[19:25:15.170] Build status: SCHEDULED
[19:25:15.170] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:13:0) after 2m24s
[19:27:39.655] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:13:0)
[19:27:39.679] Build status: SCHEDULED
[19:27:39.679] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:14:0) after 7m8s
[19:34:47.933] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:14:0)
[19:34:47.953] Build status: SCHEDULED
[19:34:47.953] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:15:0) after 7m51s
[19:36:52.105] Received PubSub notification, asking Buildbucket for the build status
[19:36:52.136] Build status: STARTED
[19:42:38.977] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:15:0)
[19:42:39.001] Build status: STARTED
[19:42:39.001] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:17:0) after 4m11s
[19:46:50.050] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:17:0)
[19:46:50.069] Build status: STARTED
[19:46:50.069] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:18:0) after 2m45s
[19:49:35.114] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:18:0)
[19:49:35.186] Build status: STARTED
[19:49:35.186] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:19:0) after 4m52s
[19:54:27.287] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:19:0)
[19:54:27.312] Build status: STARTED
[19:54:27.313] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:20:0) after 4m44s
[19:59:11.578] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:20:0)
[19:59:11.649] Build status: STARTED
[19:59:11.649] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:21:0) after 9m38s
[20:08:49.670] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:21:0)
[20:08:49.690] Build status: STARTED
[20:08:49.690] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:22:0) after 1m27s
[20:10:17.138] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:22:0)
[20:10:17.158] Build status: STARTED
[20:10:17.158] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:23:0) after 4m40s
[20:14:57.184] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:23:0)
[20:14:57.355] Build status: STARTED
[20:14:57.355] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:24:0) after 3m3s
[20:18:00.374] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:24:0)
[20:18:00.392] Build status: STARTED
[20:18:00.392] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:25:0) after 7m26s
[20:25:26.768] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:25:0)
[20:25:26.793] Build status: STARTED
[20:25:26.793] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:26:0) after 2m9s
[20:27:35.823] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:26:0)
[20:27:35.841] Build status: STARTED
[20:27:35.841] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:27:0) after 7m27s
[20:35:03.055] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:27:0)
[20:35:03.080] Build status: STARTED
[20:35:03.080] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:28:0) after 7m14s
[20:42:17.099] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:28:0)
[20:42:17.119] Build status: STARTED
[20:42:17.119] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:29:0) after 1m0s
[20:43:17.250] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:29:0)
[20:43:17.269] Build status: STARTED
[20:43:17.269] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:30:0) after 1m54s
[20:45:11.324] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:30:0)
[20:45:11.349] Build status: STARTED
[20:45:11.349] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8875772820880821520:31:0) after 8m56s
[20:53:37.188] Received PubSub notification, asking Buildbucket for the build status
[20:53:37.225] Build:
{
"id": "8710342759007138673",
"builder": {
"project": "fuchsia",
"bucket": "prod",
"builder": "clang-ci-trigger"
},
"createdBy": "project:fuchsia",
"createTime": "2025-07-03T18:20:45.847005007Z",
"startTime": "2025-07-03T19:36:47.217102364Z",
"endTime": "2025-07-03T20:53:36.795526206Z",
"updateTime": "2025-07-03T20:53:36.795526206Z",
"status": "FAILURE",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "378f248934d603e3fba9d958d2db997814d057d5",
"ref": "refs/heads/main"
}
}
}
[20:53:37.225] Invocation finished in 2h32m52.547745329s with status FAILED