[20:59:51.105] New invocation is queued and will start shortly
[20:59:53.263] Starting the invocation (attempt 1)
[20:59:53.291] Popped buildset tag "buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/3acb1eac5eb6ef4e60dd64b7845615e076cc6a3e"
[20:59:53.291] Popped gitiles commit info from properties and tags
[20:59:53.291] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[20:59:53.291] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[20:59:53.292] Buildbucket request:
{
"requestId": "8902035930994261968",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-arm64"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8902035930994261968",
"job": "fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "397e4dcdc94d3abb853ead7318df5920be697180"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@397e4dcdc94d3abb853ead7318df5920be697180",
"title": "397e4dcdc94d3abb853ead7318df5920be697180",
"url": "https://llvm.googlesource.com/llvm-project/+/397e4dcdc94d3abb853ead7318df5920be697180"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "2d13302d3851747a023ffecc6388585e888cd0e9"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@2d13302d3851747a023ffecc6388585e888cd0e9",
"title": "2d13302d3851747a023ffecc6388585e888cd0e9",
"url": "https://llvm.googlesource.com/llvm-project/+/2d13302d3851747a023ffecc6388585e888cd0e9"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "8f023ec81df2f7d26db3c90e7a197d9f75472304"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@8f023ec81df2f7d26db3c90e7a197d9f75472304",
"title": "8f023ec81df2f7d26db3c90e7a197d9f75472304",
"url": "https://llvm.googlesource.com/llvm-project/+/8f023ec81df2f7d26db3c90e7a197d9f75472304"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "b7c9ebe4ece556aa10cb592b59fe3793f4d9e6c2"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@b7c9ebe4ece556aa10cb592b59fe3793f4d9e6c2",
"title": "b7c9ebe4ece556aa10cb592b59fe3793f4d9e6c2",
"url": "https://llvm.googlesource.com/llvm-project/+/b7c9ebe4ece556aa10cb592b59fe3793f4d9e6c2"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "4eb978026152772bcdd139899e8d0192f7ddbc11"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@4eb978026152772bcdd139899e8d0192f7ddbc11",
"title": "4eb978026152772bcdd139899e8d0192f7ddbc11",
"url": "https://llvm.googlesource.com/llvm-project/+/4eb978026152772bcdd139899e8d0192f7ddbc11"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "62cdc2a347584f32dd9c351b2384c873da0f32ad"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@62cdc2a347584f32dd9c351b2384c873da0f32ad",
"title": "62cdc2a347584f32dd9c351b2384c873da0f32ad",
"url": "https://llvm.googlesource.com/llvm-project/+/62cdc2a347584f32dd9c351b2384c873da0f32ad"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "cf70a1ee815d11ae52c4a5d034e65a7a713bd06c"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@cf70a1ee815d11ae52c4a5d034e65a7a713bd06c",
"title": "cf70a1ee815d11ae52c4a5d034e65a7a713bd06c",
"url": "https://llvm.googlesource.com/llvm-project/+/cf70a1ee815d11ae52c4a5d034e65a7a713bd06c"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "e99755d41c8d5ee8594fa161ac05fbef02d902aa"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@e99755d41c8d5ee8594fa161ac05fbef02d902aa",
"title": "e99755d41c8d5ee8594fa161ac05fbef02d902aa",
"url": "https://llvm.googlesource.com/llvm-project/+/e99755d41c8d5ee8594fa161ac05fbef02d902aa"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "49c5cebb2966d5e8f0784370d818023a1054e189"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@49c5cebb2966d5e8f0784370d818023a1054e189",
"title": "49c5cebb2966d5e8f0784370d818023a1054e189",
"url": "https://llvm.googlesource.com/llvm-project/+/49c5cebb2966d5e8f0784370d818023a1054e189"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "f14fd32602a3e898b151ea0302d1d0f8cb2f5afc"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@f14fd32602a3e898b151ea0302d1d0f8cb2f5afc",
"title": "f14fd32602a3e898b151ea0302d1d0f8cb2f5afc",
"url": "https://llvm.googlesource.com/llvm-project/+/f14fd32602a3e898b151ea0302d1d0f8cb2f5afc"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "0a7a1ef2205c45859b4179cef993e97e9f5b4d0d"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@0a7a1ef2205c45859b4179cef993e97e9f5b4d0d",
"title": "0a7a1ef2205c45859b4179cef993e97e9f5b4d0d",
"url": "https://llvm.googlesource.com/llvm-project/+/0a7a1ef2205c45859b4179cef993e97e9f5b4d0d"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "d95597dc06c510ad7fbf00a43583c54d38f79aa7"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@d95597dc06c510ad7fbf00a43583c54d38f79aa7",
"title": "d95597dc06c510ad7fbf00a43583c54d38f79aa7",
"url": "https://llvm.googlesource.com/llvm-project/+/d95597dc06c510ad7fbf00a43583c54d38f79aa7"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "ddd1a0204872b859485eff941569f0f0af5dda42"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@ddd1a0204872b859485eff941569f0f0af5dda42",
"title": "ddd1a0204872b859485eff941569f0f0af5dda42",
"url": "https://llvm.googlesource.com/llvm-project/+/ddd1a0204872b859485eff941569f0f0af5dda42"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "34a4eefcbd8d394616cdb16dcadc70b934a577ce"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@34a4eefcbd8d394616cdb16dcadc70b934a577ce",
"title": "34a4eefcbd8d394616cdb16dcadc70b934a577ce",
"url": "https://llvm.googlesource.com/llvm-project/+/34a4eefcbd8d394616cdb16dcadc70b934a577ce"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "eebe9a3fca39e0d0e464993f41e63aa41c308da7"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@eebe9a3fca39e0d0e464993f41e63aa41c308da7",
"title": "eebe9a3fca39e0d0e464993f41e63aa41c308da7",
"url": "https://llvm.googlesource.com/llvm-project/+/eebe9a3fca39e0d0e464993f41e63aa41c308da7"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "50d15e688f4a88662f28d5d712f2ba2533466974"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@50d15e688f4a88662f28d5d712f2ba2533466974",
"title": "50d15e688f4a88662f28d5d712f2ba2533466974",
"url": "https://llvm.googlesource.com/llvm-project/+/50d15e688f4a88662f28d5d712f2ba2533466974"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "9a1d0744ed851ee927f32f6b06777d93e9e32561"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@9a1d0744ed851ee927f32f6b06777d93e9e32561",
"title": "9a1d0744ed851ee927f32f6b06777d93e9e32561",
"url": "https://llvm.googlesource.com/llvm-project/+/9a1d0744ed851ee927f32f6b06777d93e9e32561"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "3acb1eac5eb6ef4e60dd64b7845615e076cc6a3e"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@3acb1eac5eb6ef4e60dd64b7845615e076cc6a3e",
"title": "3acb1eac5eb6ef4e60dd64b7845615e076cc6a3e",
"url": "https://llvm.googlesource.com/llvm-project/+/3acb1eac5eb6ef4e60dd64b7845615e076cc6a3e"
}
]
}
},
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "3acb1eac5eb6ef4e60dd64b7845615e076cc6a3e",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8902035930994261968"
},
{
"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"
}
}
[20:59:53.792] Scheduled build:
{
"id": "8736605867973844049",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-arm64"
},
"createdBy": "project:fuchsia",
"createTime": "2024-09-16T20:59:53.357322163Z",
"updateTime": "2024-09-16T20:59:53.357322163Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "3acb1eac5eb6ef4e60dd64b7845615e076cc6a3e",
"ref": "refs/heads/main"
}
},
"canary": true
}
[20:59:53.792] Task URL: https://cr-buildbucket.appspot.com/build/8736605867973844049
[20:59:53.792] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:2:0) after 9m20s
[20:59:54.725] Received PubSub notification, asking Buildbucket for the build status
[20:59:54.754] Build status: SCHEDULED
[21:00:00.446] Received PubSub notification, asking Buildbucket for the build status
[21:00:00.520] Build status: STARTED
[21:09:13.845] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:2:0)
[21:09:13.867] Build status: STARTED
[21:09:13.867] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:5:0) after 9m46s
[21:18:59.867] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:5:0)
[21:18:59.943] Build status: STARTED
[21:18:59.943] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:6:0) after 1m48s
[21:20:47.943] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:6:0)
[21:20:47.964] Build status: STARTED
[21:20:47.964] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:7:0) after 1m7s
[21:21:54.997] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:7:0)
[21:21:55.032] Build status: STARTED
[21:21:55.032] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:8:0) after 8m53s
[21:30:48.087] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:8:0)
[21:30:48.110] Build status: STARTED
[21:30:48.110] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:9:0) after 6m28s
[21:37:16.225] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:9:0)
[21:37:16.242] Build status: STARTED
[21:37:16.242] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:10:0) after 4m54s
[21:42:10.289] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:10:0)
[21:42:10.313] Build status: STARTED
[21:42:10.313] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:11:0) after 1m21s
[21:43:31.381] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:11:0)
[21:43:31.433] Build status: STARTED
[21:43:31.433] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:12:0) after 5m9s
[21:48:40.752] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:12:0)
[21:48:40.781] Build status: STARTED
[21:48:40.781] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:13:0) after 1m19s
[21:49:59.848] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:13:0)
[21:49:59.874] Build status: STARTED
[21:49:59.874] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:14:0) after 4m26s
[21:54:25.929] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:14:0)
[21:54:25.953] Build status: STARTED
[21:54:25.953] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:15:0) after 7m21s
[22:01:47.087] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:15:0)
[22:01:47.108] Build status: STARTED
[22:01:47.108] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:16:0) after 8m0s
[22:09:47.129] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:16:0)
[22:09:47.150] Build status: STARTED
[22:09:47.150] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:17:0) after 8m46s
[22:18:33.167] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:17:0)
[22:18:33.185] Build status: STARTED
[22:18:33.185] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:18:0) after 8m47s
[22:27:20.276] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:18:0)
[22:27:20.296] Build status: STARTED
[22:27:20.296] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-arm64-40be1bb5:8902035930994261968:19:0) after 9m56s
[22:29:24.394] Received PubSub notification, asking Buildbucket for the build status
[22:29:24.461] Build:
{
"id": "8736605867973844049",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-arm64"
},
"createdBy": "project:fuchsia",
"createTime": "2024-09-16T20:59:53.357322163Z",
"startTime": "2024-09-16T21:00:00.015420421Z",
"endTime": "2024-09-16T22:29:23.079068788Z",
"updateTime": "2024-09-16T22:29:23.079068788Z",
"status": "FAILURE",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "3acb1eac5eb6ef4e60dd64b7845615e076cc6a3e",
"ref": "refs/heads/main"
}
},
"canary": true
}
[22:29:24.461] Invocation finished in 1h29m33.36879479s with status FAILED