[22:58:40.705] New invocation is queued and will start shortly
[22:58:41.915] Starting the invocation (attempt 1)
[22:58:41.939] Popped buildset tag "buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/aeea056f604200e3acd78cf279d1ea41eb3f2bfd"
[22:58:41.939] Popped gitiles commit info from properties and tags
[22:58:41.939] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[22:58:41.940] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[22:58:41.940] Buildbucket request:
{
"requestId": "8861984595921427456",
"builder": {
"project": "fuchsia",
"bucket": "prod",
"builder": "clang-ci-trigger"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8861984595921427456",
"job": "fuchsia/prod-clang-ci-trigger-40be1bb5",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "f0e1254bce44b85bdeb14fb5318163dab72ccff6"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@f0e1254bce44b85bdeb14fb5318163dab72ccff6",
"title": "f0e1254bce44b85bdeb14fb5318163dab72ccff6",
"url": "https://llvm.googlesource.com/llvm-project/+/f0e1254bce44b85bdeb14fb5318163dab72ccff6"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "4006df9b3276a8c8f03194e09386465d3b611b88"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@4006df9b3276a8c8f03194e09386465d3b611b88",
"title": "4006df9b3276a8c8f03194e09386465d3b611b88",
"url": "https://llvm.googlesource.com/llvm-project/+/4006df9b3276a8c8f03194e09386465d3b611b88"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "bd5fa633355638f4e9b176ca82007ff755bb51e9"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@bd5fa633355638f4e9b176ca82007ff755bb51e9",
"title": "bd5fa633355638f4e9b176ca82007ff755bb51e9",
"url": "https://llvm.googlesource.com/llvm-project/+/bd5fa633355638f4e9b176ca82007ff755bb51e9"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "d3256d935dbd0d9c7c1a525b347783d760e2cb98"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@d3256d935dbd0d9c7c1a525b347783d760e2cb98",
"title": "d3256d935dbd0d9c7c1a525b347783d760e2cb98",
"url": "https://llvm.googlesource.com/llvm-project/+/d3256d935dbd0d9c7c1a525b347783d760e2cb98"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "41519b390fa1ae90221af33342d24fd4caa4734f"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@41519b390fa1ae90221af33342d24fd4caa4734f",
"title": "41519b390fa1ae90221af33342d24fd4caa4734f",
"url": "https://llvm.googlesource.com/llvm-project/+/41519b390fa1ae90221af33342d24fd4caa4734f"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "fff45ddcc05eeed711d19392fcc6786674fa56ca"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@fff45ddcc05eeed711d19392fcc6786674fa56ca",
"title": "fff45ddcc05eeed711d19392fcc6786674fa56ca",
"url": "https://llvm.googlesource.com/llvm-project/+/fff45ddcc05eeed711d19392fcc6786674fa56ca"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "434127b0c1dbd95a9c776fdf266d51e21da3f770"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@434127b0c1dbd95a9c776fdf266d51e21da3f770",
"title": "434127b0c1dbd95a9c776fdf266d51e21da3f770",
"url": "https://llvm.googlesource.com/llvm-project/+/434127b0c1dbd95a9c776fdf266d51e21da3f770"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "9885aed474acccccda929f9d784c48ae0041939a"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@9885aed474acccccda929f9d784c48ae0041939a",
"title": "9885aed474acccccda929f9d784c48ae0041939a",
"url": "https://llvm.googlesource.com/llvm-project/+/9885aed474acccccda929f9d784c48ae0041939a"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "ec6091f4de8a530af198f259db1622e99b2bd954"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@ec6091f4de8a530af198f259db1622e99b2bd954",
"title": "ec6091f4de8a530af198f259db1622e99b2bd954",
"url": "https://llvm.googlesource.com/llvm-project/+/ec6091f4de8a530af198f259db1622e99b2bd954"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "aeea056f604200e3acd78cf279d1ea41eb3f2bfd"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@aeea056f604200e3acd78cf279d1ea41eb3f2bfd",
"title": "aeea056f604200e3acd78cf279d1ea41eb3f2bfd",
"url": "https://llvm.googlesource.com/llvm-project/+/aeea056f604200e3acd78cf279d1ea41eb3f2bfd"
}
]
}
},
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "aeea056f604200e3acd78cf279d1ea41eb3f2bfd",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8861984595921427456"
},
{
"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"
}
}
[22:58:42.299] Scheduled build:
{
"id": "8696554533907478945",
"builder": {
"project": "fuchsia",
"bucket": "prod",
"builder": "clang-ci-trigger"
},
"createdBy": "project:fuchsia",
"createTime": "2025-12-02T22:58:41.994345438Z",
"updateTime": "2025-12-02T22:58:41.994345438Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "aeea056f604200e3acd78cf279d1ea41eb3f2bfd",
"ref": "refs/heads/main"
}
},
"canary": true
}
[22:58:42.299] Task URL: https://cr-buildbucket.appspot.com/build/8696554533907478945
[22:58:42.299] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:2:0) after 9m1s
[22:58:43.292] Received PubSub notification, asking Buildbucket for the build status
[22:58:43.307] Build status: SCHEDULED
[22:58:46.290] Received PubSub notification, asking Buildbucket for the build status
[22:58:46.308] Build status: STARTED
[23:07:43.312] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:2:0)
[23:07:43.336] Build status: STARTED
[23:07:43.336] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:5:0) after 2m2s
[23:09:45.353] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:5:0)
[23:09:45.371] Build status: STARTED
[23:09:45.371] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:6:0) after 6m40s
[23:16:25.385] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:6:0)
[23:16:25.412] Build status: STARTED
[23:16:25.412] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:7:0) after 5m32s
[23:21:57.426] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:7:0)
[23:21:57.456] Build status: STARTED
[23:21:57.456] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:8:0) after 1m23s
[23:23:20.480] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:8:0)
[23:23:20.546] Build status: STARTED
[23:23:20.546] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:9:0) after 1m34s
[23:24:54.561] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:9:0)
[23:24:54.624] Build status: STARTED
[23:24:54.624] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:10:0) after 4m20s
[23:29:14.642] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:10:0)
[23:29:14.681] Build status: STARTED
[23:29:14.681] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:11:0) after 5m31s
[23:34:45.686] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:11:0)
[23:34:45.705] Build status: STARTED
[23:34:45.705] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:12:0) after 5m38s
[23:40:23.769] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:12:0)
[23:40:23.782] Build status: STARTED
[23:40:23.782] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:13:0) after 5m50s
[23:46:13.770] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:13:0)
[23:46:13.840] Build status: STARTED
[23:46:13.840] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:14:0) after 7m33s
[23:53:46.819] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:14:0)
[23:53:46.834] Build status: STARTED
[23:53:46.834] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:15:0) after 2m27s
[23:56:13.848] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:15:0)
[23:56:13.862] Build status: STARTED
[23:56:13.862] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:16:0) after 8m37s
[00:04:50.882] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:16:0)
[00:04:50.905] Build status: STARTED
[00:04:50.905] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:17:0) after 2m35s
[00:07:25.929] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:17:0)
[00:07:25.947] Build status: STARTED
[00:07:25.947] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:18:0) after 6m13s
[00:13:39.136] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:18:0)
[00:13:39.182] Build status: STARTED
[00:13:39.182] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:19:0) after 1m2s
[00:14:41.234] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:19:0)
[00:14:41.253] Build status: STARTED
[00:14:41.253] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8861984595921427456:20:0) after 1m18s
[00:15:39.741] Received PubSub notification, asking Buildbucket for the build status
[00:15:39.759] Build:
{
"id": "8696554533907478945",
"builder": {
"project": "fuchsia",
"bucket": "prod",
"builder": "clang-ci-trigger"
},
"createdBy": "project:fuchsia",
"createTime": "2025-12-02T22:58:41.994345438Z",
"startTime": "2025-12-02T22:58:46.060273230Z",
"endTime": "2025-12-03T00:15:38.294962541Z",
"updateTime": "2025-12-03T00:15:38.294962541Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "aeea056f604200e3acd78cf279d1ea41eb3f2bfd",
"ref": "refs/heads/main"
}
},
"canary": true
}
[00:15:39.759] Invocation finished in 1h16m59.070143459s with status SUCCEEDED