[23:51:31.197] New invocation is queued and will start shortly
[23:51:32.513] Starting the invocation (attempt 1)
[23:51:32.540] Popped buildset tag "buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/49d48c32e04742ebd05cbbd7dd544b1217b6d9d0"
[23:51:32.540] Popped gitiles commit info from properties and tags
[23:51:32.540] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[23:51:32.540] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[23:51:32.540] Buildbucket request:
{
"requestId": "8879013501092028912",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-arm64"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8879013501092028912",
"job": "fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "1d48e5549f583f501343a9f7c17c1cbda6848a3f"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@1d48e5549f583f501343a9f7c17c1cbda6848a3f",
"title": "1d48e5549f583f501343a9f7c17c1cbda6848a3f",
"url": "https://llvm.googlesource.com/llvm-project/+/1d48e5549f583f501343a9f7c17c1cbda6848a3f"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "8199f181cd42e45cbcca095c5c700930215d2c86"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@8199f181cd42e45cbcca095c5c700930215d2c86",
"title": "8199f181cd42e45cbcca095c5c700930215d2c86",
"url": "https://llvm.googlesource.com/llvm-project/+/8199f181cd42e45cbcca095c5c700930215d2c86"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "79ae407c95715f0be5a78260c3b135090f679637"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@79ae407c95715f0be5a78260c3b135090f679637",
"title": "79ae407c95715f0be5a78260c3b135090f679637",
"url": "https://llvm.googlesource.com/llvm-project/+/79ae407c95715f0be5a78260c3b135090f679637"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "893ef7ffbd077463ca89e7317a2aef2c7f9d37d7"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@893ef7ffbd077463ca89e7317a2aef2c7f9d37d7",
"title": "893ef7ffbd077463ca89e7317a2aef2c7f9d37d7",
"url": "https://llvm.googlesource.com/llvm-project/+/893ef7ffbd077463ca89e7317a2aef2c7f9d37d7"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "42c8742e0e2d24d195c91308fc0764d99dbe9571"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@42c8742e0e2d24d195c91308fc0764d99dbe9571",
"title": "42c8742e0e2d24d195c91308fc0764d99dbe9571",
"url": "https://llvm.googlesource.com/llvm-project/+/42c8742e0e2d24d195c91308fc0764d99dbe9571"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "ed5eb1c6c6c3e1bb53448d8916ecf7c91fdb692e"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@ed5eb1c6c6c3e1bb53448d8916ecf7c91fdb692e",
"title": "ed5eb1c6c6c3e1bb53448d8916ecf7c91fdb692e",
"url": "https://llvm.googlesource.com/llvm-project/+/ed5eb1c6c6c3e1bb53448d8916ecf7c91fdb692e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "49d48c32e04742ebd05cbbd7dd544b1217b6d9d0"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@49d48c32e04742ebd05cbbd7dd544b1217b6d9d0",
"title": "49d48c32e04742ebd05cbbd7dd544b1217b6d9d0",
"url": "https://llvm.googlesource.com/llvm-project/+/49d48c32e04742ebd05cbbd7dd544b1217b6d9d0"
}
]
}
},
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "49d48c32e04742ebd05cbbd7dd544b1217b6d9d0",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8879013501092028912"
},
{
"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"
}
}
[23:51:32.982] Scheduled build:
{
"id": "8713583438956220529",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-arm64"
},
"createdBy": "project:fuchsia",
"createTime": "2025-05-28T23:51:32.612592580Z",
"updateTime": "2025-05-28T23:51:32.612592580Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "49d48c32e04742ebd05cbbd7dd544b1217b6d9d0",
"ref": "refs/heads/main"
}
}
}
[23:51:32.982] Task URL: https://cr-buildbucket.appspot.com/build/8713583438956220529
[23:51:32.982] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:2:0) after 3m20s
[23:51:33.959] Received PubSub notification, asking Buildbucket for the build status
[23:51:33.981] Build status: SCHEDULED
[23:51:37.767] Received PubSub notification, asking Buildbucket for the build status
[23:51:37.785] Build status: STARTED
[23:54:52.996] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:2:0)
[23:54:53.018] Build status: STARTED
[23:54:53.018] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:5:0) after 3m12s
[23:58:05.044] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:5:0)
[23:58:05.070] Build status: STARTED
[23:58:05.070] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:6:0) after 9m46s
[00:07:51.221] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:6:0)
[00:07:51.244] Build status: STARTED
[00:07:51.244] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:7:0) after 4m31s
[00:12:22.264] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:7:0)
[00:12:22.292] Build status: STARTED
[00:12:22.293] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:8:0) after 8m25s
[00:20:47.315] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:8:0)
[00:20:47.338] Build status: STARTED
[00:20:47.338] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:9:0) after 3m30s
[00:24:17.378] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:9:0)
[00:24:17.400] Build status: STARTED
[00:24:17.400] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:10:0) after 5m59s
[00:30:16.413] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:10:0)
[00:30:16.431] Build status: STARTED
[00:30:16.431] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:11:0) after 4m40s
[00:34:56.470] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:11:0)
[00:34:56.491] Build status: STARTED
[00:34:56.491] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:12:0) after 1m17s
[00:36:13.577] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:12:0)
[00:36:13.598] Build status: STARTED
[00:36:13.598] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:13:0) after 5m38s
[00:41:51.636] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:13:0)
[00:41:51.704] Build status: STARTED
[00:41:51.704] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:14:0) after 9m15s
[00:51:06.747] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:14:0)
[00:51:06.861] Build status: STARTED
[00:51:06.861] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:15:0) after 2m40s
[00:53:46.970] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:15:0)
[00:53:47.004] Build status: STARTED
[00:53:47.004] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:16:0) after 7m39s
[01:01:26.027] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:16:0)
[01:01:26.060] Build status: STARTED
[01:01:26.060] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:17:0) after 8m23s
[01:09:49.158] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:17:0)
[01:09:49.181] Build status: STARTED
[01:09:49.181] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:18:0) after 1m36s
[01:11:25.210] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:18:0)
[01:11:25.230] Build status: STARTED
[01:11:25.230] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:19:0) after 5m49s
[01:17:14.231] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:19:0)
[01:17:14.270] Build status: STARTED
[01:17:14.270] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:20:0) after 7m39s
[01:24:53.277] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:20:0)
[01:24:53.300] Build status: STARTED
[01:24:53.300] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:21:0) after 5m27s
[01:30:20.384] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:21:0)
[01:30:20.409] Build status: STARTED
[01:30:20.409] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:22:0) after 7m51s
[01:38:11.448] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:22:0)
[01:38:11.474] Build status: STARTED
[01:38:11.474] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:23:0) after 8m24s
[01:46:35.493] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:23:0)
[01:46:35.538] Build status: STARTED
[01:46:35.538] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8879013501092028912:24:0) after 2m27s
[01:48:00.711] Received PubSub notification, asking Buildbucket for the build status
[01:48:00.730] Build:
{
"id": "8713583438956220529",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-arm64"
},
"createdBy": "project:fuchsia",
"createTime": "2025-05-28T23:51:32.612592580Z",
"startTime": "2025-05-28T23:51:37.518427251Z",
"endTime": "2025-05-29T01:48:00.309089460Z",
"updateTime": "2025-05-29T01:48:00.309089460Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "49d48c32e04742ebd05cbbd7dd544b1217b6d9d0",
"ref": "refs/heads/main"
}
}
}
[01:48:00.730] Invocation finished in 1h56m29.538308484s with status SUCCEEDED