[10:25:57.211] New invocation is queued and will start shortly
[10:25:58.241] Starting the invocation (attempt 1)
[10:25:58.273] Popped buildset tag "buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/1509b46ea5617402634270a01e840356ef935436"
[10:25:58.273] Popped gitiles commit info from properties and tags
[10:25:58.273] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[10:25:58.273] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[10:25:58.274] Buildbucket request:
{
"requestId": "8887942685657610736",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-arm64"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8887942685657610736",
"job": "fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "b9a1e58b2c63c9c0ef775d97d6728b64083a2239"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@b9a1e58b2c63c9c0ef775d97d6728b64083a2239",
"title": "b9a1e58b2c63c9c0ef775d97d6728b64083a2239",
"url": "https://llvm.googlesource.com/llvm-project/+/b9a1e58b2c63c9c0ef775d97d6728b64083a2239"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "99aea2176ba2327264501befbbd8dc6da4d64f94"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@99aea2176ba2327264501befbbd8dc6da4d64f94",
"title": "99aea2176ba2327264501befbbd8dc6da4d64f94",
"url": "https://llvm.googlesource.com/llvm-project/+/99aea2176ba2327264501befbbd8dc6da4d64f94"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "a2f9ae1421a31e987a4d0c7352137d371709f41d"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@a2f9ae1421a31e987a4d0c7352137d371709f41d",
"title": "a2f9ae1421a31e987a4d0c7352137d371709f41d",
"url": "https://llvm.googlesource.com/llvm-project/+/a2f9ae1421a31e987a4d0c7352137d371709f41d"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "55fb793dc9ea8cb81169e54133d0603bc9c02840"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@55fb793dc9ea8cb81169e54133d0603bc9c02840",
"title": "55fb793dc9ea8cb81169e54133d0603bc9c02840",
"url": "https://llvm.googlesource.com/llvm-project/+/55fb793dc9ea8cb81169e54133d0603bc9c02840"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "d4cb75ef8b67864678182e7f21227f4365893578"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@d4cb75ef8b67864678182e7f21227f4365893578",
"title": "d4cb75ef8b67864678182e7f21227f4365893578",
"url": "https://llvm.googlesource.com/llvm-project/+/d4cb75ef8b67864678182e7f21227f4365893578"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "8900e412aec04b202b9f071d110f96546989beef"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@8900e412aec04b202b9f071d110f96546989beef",
"title": "8900e412aec04b202b9f071d110f96546989beef",
"url": "https://llvm.googlesource.com/llvm-project/+/8900e412aec04b202b9f071d110f96546989beef"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "f3f4afe43f4e0f2a07bfb53ba70507e663c9996c"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@f3f4afe43f4e0f2a07bfb53ba70507e663c9996c",
"title": "f3f4afe43f4e0f2a07bfb53ba70507e663c9996c",
"url": "https://llvm.googlesource.com/llvm-project/+/f3f4afe43f4e0f2a07bfb53ba70507e663c9996c"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "029c8e783d17d55541b308ee6db5429d54cb5153"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@029c8e783d17d55541b308ee6db5429d54cb5153",
"title": "029c8e783d17d55541b308ee6db5429d54cb5153",
"url": "https://llvm.googlesource.com/llvm-project/+/029c8e783d17d55541b308ee6db5429d54cb5153"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "4af8c5382e12a74a3c79c573e029d681719a323b"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@4af8c5382e12a74a3c79c573e029d681719a323b",
"title": "4af8c5382e12a74a3c79c573e029d681719a323b",
"url": "https://llvm.googlesource.com/llvm-project/+/4af8c5382e12a74a3c79c573e029d681719a323b"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "cc539138acf742f53ef455147182a8de11980a02"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@cc539138acf742f53ef455147182a8de11980a02",
"title": "cc539138acf742f53ef455147182a8de11980a02",
"url": "https://llvm.googlesource.com/llvm-project/+/cc539138acf742f53ef455147182a8de11980a02"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "8615f9aaffd4337a33ea979f010c4d6410ba6125"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@8615f9aaffd4337a33ea979f010c4d6410ba6125",
"title": "8615f9aaffd4337a33ea979f010c4d6410ba6125",
"url": "https://llvm.googlesource.com/llvm-project/+/8615f9aaffd4337a33ea979f010c4d6410ba6125"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "17602893409a0d396d37162a3b42254689e02e09"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@17602893409a0d396d37162a3b42254689e02e09",
"title": "17602893409a0d396d37162a3b42254689e02e09",
"url": "https://llvm.googlesource.com/llvm-project/+/17602893409a0d396d37162a3b42254689e02e09"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "2260d592578082abd0e1f57bab7d4d9b18b687d1"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@2260d592578082abd0e1f57bab7d4d9b18b687d1",
"title": "2260d592578082abd0e1f57bab7d4d9b18b687d1",
"url": "https://llvm.googlesource.com/llvm-project/+/2260d592578082abd0e1f57bab7d4d9b18b687d1"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "db597084c5dbbf896d121b74ba80a7a76250fc78"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@db597084c5dbbf896d121b74ba80a7a76250fc78",
"title": "db597084c5dbbf896d121b74ba80a7a76250fc78",
"url": "https://llvm.googlesource.com/llvm-project/+/db597084c5dbbf896d121b74ba80a7a76250fc78"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "0607f94280820d38d4f120952a6a09891a046853"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@0607f94280820d38d4f120952a6a09891a046853",
"title": "0607f94280820d38d4f120952a6a09891a046853",
"url": "https://llvm.googlesource.com/llvm-project/+/0607f94280820d38d4f120952a6a09891a046853"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "c442b39770baa397a98ecfb79719cc09081e4a81"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@c442b39770baa397a98ecfb79719cc09081e4a81",
"title": "c442b39770baa397a98ecfb79719cc09081e4a81",
"url": "https://llvm.googlesource.com/llvm-project/+/c442b39770baa397a98ecfb79719cc09081e4a81"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "160da73b8583b2f94cba81b220710684a9590da3"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@160da73b8583b2f94cba81b220710684a9590da3",
"title": "160da73b8583b2f94cba81b220710684a9590da3",
"url": "https://llvm.googlesource.com/llvm-project/+/160da73b8583b2f94cba81b220710684a9590da3"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "7781e1040dc5b4a920628ee086e239cf46f74e49"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@7781e1040dc5b4a920628ee086e239cf46f74e49",
"title": "7781e1040dc5b4a920628ee086e239cf46f74e49",
"url": "https://llvm.googlesource.com/llvm-project/+/7781e1040dc5b4a920628ee086e239cf46f74e49"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "1509b46ea5617402634270a01e840356ef935436"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@1509b46ea5617402634270a01e840356ef935436",
"title": "1509b46ea5617402634270a01e840356ef935436",
"url": "https://llvm.googlesource.com/llvm-project/+/1509b46ea5617402634270a01e840356ef935436"
}
]
}
},
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "1509b46ea5617402634270a01e840356ef935436",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8887942685657610736"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[10:25:58.769] Scheduled build:
{
"id": "8722512623823433665",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-arm64"
},
"createdBy": "project:fuchsia",
"createTime": "2025-02-19T10:25:58.338841080Z",
"updateTime": "2025-02-19T10:25:58.338841080Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "1509b46ea5617402634270a01e840356ef935436",
"ref": "refs/heads/main"
}
}
}
[10:25:58.769] Task URL: https://cr-buildbucket.appspot.com/build/8722512623823433665
[10:25:58.769] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:2:0) after 4m43s
[10:25:59.756] Received PubSub notification, asking Buildbucket for the build status
[10:25:59.778] Build status: SCHEDULED
[10:26:03.574] Received PubSub notification, asking Buildbucket for the build status
[10:26:03.603] Build status: STARTED
[10:30:41.895] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:2:0)
[10:30:41.927] Build status: STARTED
[10:30:41.927] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:5:0) after 1m28s
[10:32:09.924] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:5:0)
[10:32:09.971] Build status: STARTED
[10:32:09.971] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:6:0) after 2m2s
[10:34:12.000] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:6:0)
[10:34:12.037] Build status: STARTED
[10:34:12.037] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:7:0) after 6m58s
[10:41:10.523] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:7:0)
[10:41:10.544] Build status: STARTED
[10:41:10.544] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:8:0) after 1m50s
[10:43:00.730] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:8:0)
[10:43:00.754] Build status: STARTED
[10:43:00.754] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:9:0) after 7m36s
[10:50:36.773] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:9:0)
[10:50:36.854] Build status: STARTED
[10:50:36.854] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:10:0) after 6m12s
[10:56:48.890] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:10:0)
[10:56:48.913] Build status: STARTED
[10:56:48.914] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:11:0) after 3m1s
[10:59:50.029] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:11:0)
[10:59:50.055] Build status: STARTED
[10:59:50.055] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:12:0) after 6m3s
[11:05:53.181] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:12:0)
[11:05:53.207] Build status: STARTED
[11:05:53.207] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:13:0) after 3m38s
[11:09:31.473] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:13:0)
[11:09:31.507] Build status: STARTED
[11:09:31.507] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:14:0) after 1m15s
[11:10:46.623] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:14:0)
[11:10:46.641] Build status: STARTED
[11:10:46.641] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:15:0) after 3m22s
[11:14:08.658] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:15:0)
[11:14:08.713] Build status: STARTED
[11:14:08.713] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:16:0) after 5m33s
[11:19:41.816] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:16:0)
[11:19:41.830] Build status: STARTED
[11:19:41.830] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:17:0) after 4m3s
[11:23:44.902] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:17:0)
[11:23:44.923] Build status: STARTED
[11:23:44.923] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:18:0) after 8m22s
[11:32:07.067] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:18:0)
[11:32:07.092] Build status: STARTED
[11:32:07.092] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:19:0) after 4m38s
[11:36:45.235] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:19:0)
[11:36:45.268] Build status: STARTED
[11:36:45.268] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:20:0) after 6m40s
[11:43:25.807] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:20:0)
[11:43:25.832] Build status: STARTED
[11:43:25.832] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:21:0) after 1m51s
[11:45:17.371] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:21:0)
[11:45:17.387] Build status: STARTED
[11:45:17.387] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:22:0) after 6m4s
[11:51:21.663] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:22:0)
[11:51:21.692] Build status: STARTED
[11:51:21.692] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:23:0) after 6m18s
[11:57:40.279] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:23:0)
[11:57:40.301] Build status: STARTED
[11:57:40.301] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:24:0) after 6m52s
[12:04:32.301] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:24:0)
[12:04:32.328] Build status: STARTED
[12:04:32.328] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:25:0) after 4m59s
[12:09:31.356] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:25:0)
[12:09:31.386] Build status: STARTED
[12:09:31.386] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:26:0) after 1m54s
[12:11:25.407] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:26:0)
[12:11:25.479] Build status: STARTED
[12:11:25.479] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8887942685657610736:27:0) after 4m10s
[12:13:29.179] Received PubSub notification, asking Buildbucket for the build status
[12:13:29.198] Build:
{
"id": "8722512623823433665",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-arm64"
},
"createdBy": "project:fuchsia",
"createTime": "2025-02-19T10:25:58.338841080Z",
"startTime": "2025-02-19T10:26:03.229176693Z",
"endTime": "2025-02-19T12:13:28.774125Z",
"updateTime": "2025-02-19T12:13:28.774125Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "1509b46ea5617402634270a01e840356ef935436",
"ref": "refs/heads/main"
}
}
}
[12:13:29.198] Invocation finished in 1h47m31.992875299s with status SUCCEEDED