[20:18:08.509] New invocation is queued and will start shortly
[20:18:09.654] Starting the invocation (attempt 1)
[20:18:09.679] Popped buildset tag "buildset:commit/gitiles/fuchsia.googlesource.com/integration/+/d3e8ea33a3cb6890599e5cba83526653fdb55d1d"
[20:18:09.679] Popped gitiles commit info from properties and tags
[20:18:09.679] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[20:18:09.679] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[20:18:09.680] Buildbucket request:
{
"requestId": "8877124389397374960",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "sdk-core-mac"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8877124389397374960",
"job": "fuchsia/global.ci-sdk-core-mac-e5a0ec7f",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "f01127b60e9ea4e9796a37d57a7d539b6c783582"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@f01127b60e9ea4e9796a37d57a7d539b6c783582",
"title": "f01127b60e9ea4e9796a37d57a7d539b6c783582",
"url": "https://fuchsia.googlesource.com/integration/+/f01127b60e9ea4e9796a37d57a7d539b6c783582"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "5104a60ef092004ebd6367e2dde954c810307d19"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@5104a60ef092004ebd6367e2dde954c810307d19",
"title": "5104a60ef092004ebd6367e2dde954c810307d19",
"url": "https://fuchsia.googlesource.com/integration/+/5104a60ef092004ebd6367e2dde954c810307d19"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "28eaabfe6bed74d6119571f26dd4323a48621b8e"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@28eaabfe6bed74d6119571f26dd4323a48621b8e",
"title": "28eaabfe6bed74d6119571f26dd4323a48621b8e",
"url": "https://fuchsia.googlesource.com/integration/+/28eaabfe6bed74d6119571f26dd4323a48621b8e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "42c3e3e06228d82a98251acea28f45810a90e40c"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@42c3e3e06228d82a98251acea28f45810a90e40c",
"title": "42c3e3e06228d82a98251acea28f45810a90e40c",
"url": "https://fuchsia.googlesource.com/integration/+/42c3e3e06228d82a98251acea28f45810a90e40c"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "1e454007ee10001e83b657abf84e4b14645732b6"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@1e454007ee10001e83b657abf84e4b14645732b6",
"title": "1e454007ee10001e83b657abf84e4b14645732b6",
"url": "https://fuchsia.googlesource.com/integration/+/1e454007ee10001e83b657abf84e4b14645732b6"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "f2326f7dced7eeb5e9a9e97789b80a528b7e9938"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@f2326f7dced7eeb5e9a9e97789b80a528b7e9938",
"title": "f2326f7dced7eeb5e9a9e97789b80a528b7e9938",
"url": "https://fuchsia.googlesource.com/integration/+/f2326f7dced7eeb5e9a9e97789b80a528b7e9938"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "a2a0f5c5f69f712bb13757458f15a285d4b065a8"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@a2a0f5c5f69f712bb13757458f15a285d4b065a8",
"title": "a2a0f5c5f69f712bb13757458f15a285d4b065a8",
"url": "https://fuchsia.googlesource.com/integration/+/a2a0f5c5f69f712bb13757458f15a285d4b065a8"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "51246a667892fc5ee044f6a6a4e43f938a4c5102"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@51246a667892fc5ee044f6a6a4e43f938a4c5102",
"title": "51246a667892fc5ee044f6a6a4e43f938a4c5102",
"url": "https://fuchsia.googlesource.com/integration/+/51246a667892fc5ee044f6a6a4e43f938a4c5102"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "88bc850c222d33bc19346a145651b30b1523cee6"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@88bc850c222d33bc19346a145651b30b1523cee6",
"title": "88bc850c222d33bc19346a145651b30b1523cee6",
"url": "https://fuchsia.googlesource.com/integration/+/88bc850c222d33bc19346a145651b30b1523cee6"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "652bcbddd7a81dc9c91da8af62d7a44f04e6e81c"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@652bcbddd7a81dc9c91da8af62d7a44f04e6e81c",
"title": "652bcbddd7a81dc9c91da8af62d7a44f04e6e81c",
"url": "https://fuchsia.googlesource.com/integration/+/652bcbddd7a81dc9c91da8af62d7a44f04e6e81c"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "d3e8ea33a3cb6890599e5cba83526653fdb55d1d"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@d3e8ea33a3cb6890599e5cba83526653fdb55d1d",
"title": "d3e8ea33a3cb6890599e5cba83526653fdb55d1d",
"url": "https://fuchsia.googlesource.com/integration/+/d3e8ea33a3cb6890599e5cba83526653fdb55d1d"
}
]
}
},
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "d3e8ea33a3cb6890599e5cba83526653fdb55d1d",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8877124389397374960"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/global.ci-sdk-core-mac-e5a0ec7f"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[20:18:10.073] Scheduled build:
{
"id": "8711694327453032609",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "sdk-core-mac"
},
"createdBy": "project:fuchsia",
"createTime": "2025-06-18T20:18:09.734711536Z",
"updateTime": "2025-06-18T20:18:09.734711536Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "d3e8ea33a3cb6890599e5cba83526653fdb55d1d",
"ref": "refs/heads/main"
}
}
}
[20:18:10.073] Task URL: https://cr-buildbucket.appspot.com/build/8711694327453032609
[20:18:10.073] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:2:0) after 4m41s
[20:18:10.175] Received PubSub notification, asking Buildbucket for the build status
[20:18:10.197] Build status: SCHEDULED
[20:18:14.592] Received PubSub notification, asking Buildbucket for the build status
[20:18:14.658] Build status: STARTED
[20:22:51.087] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:2:0)
[20:22:51.115] Build status: STARTED
[20:22:51.115] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:5:0) after 3m45s
[20:26:36.142] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:5:0)
[20:26:36.169] Build status: STARTED
[20:26:36.169] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:6:0) after 4m15s
[20:30:51.222] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:6:0)
[20:30:51.251] Build status: STARTED
[20:30:51.251] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:7:0) after 7m6s
[20:37:57.266] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:7:0)
[20:37:57.293] Build status: STARTED
[20:37:57.293] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:8:0) after 5m31s
[20:43:28.363] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:8:0)
[20:43:28.392] Build status: STARTED
[20:43:28.392] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:9:0) after 4m24s
[20:47:52.445] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:9:0)
[20:47:52.465] Build status: STARTED
[20:47:52.465] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:10:0) after 3m59s
[20:51:51.529] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:10:0)
[20:51:51.557] Build status: STARTED
[20:51:51.557] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:11:0) after 8m56s
[21:00:47.573] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:11:0)
[21:00:47.598] Build status: STARTED
[21:00:47.598] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:12:0) after 9m2s
[21:09:49.621] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:12:0)
[21:09:49.642] Build status: STARTED
[21:09:49.642] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:13:0) after 1m42s
[21:11:31.759] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:13:0)
[21:11:31.784] Build status: STARTED
[21:11:31.784] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:14:0) after 1m34s
[21:13:05.874] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:14:0)
[21:13:05.903] Build status: STARTED
[21:13:05.903] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:15:0) after 7m58s
[21:21:03.973] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:15:0)
[21:21:03.988] Build status: STARTED
[21:21:03.988] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:16:0) after 6m44s
[21:27:48.039] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:16:0)
[21:27:48.055] Build status: STARTED
[21:27:48.055] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:17:0) after 7m58s
[21:35:46.161] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:17:0)
[21:35:46.185] Build status: STARTED
[21:35:46.185] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:18:0) after 4m6s
[21:39:52.254] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:18:0)
[21:39:52.285] Build status: STARTED
[21:39:52.285] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:19:0) after 5m56s
[21:45:48.303] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:19:0)
[21:45:48.324] Build status: STARTED
[21:45:48.324] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:20:0) after 1m48s
[21:47:36.346] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:20:0)
[21:47:36.481] Build status: STARTED
[21:47:36.481] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:21:0) after 7m5s
[21:54:41.502] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:21:0)
[21:54:41.522] Build status: STARTED
[21:54:41.522] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:22:0) after 2m26s
[21:57:07.590] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:22:0)
[21:57:07.608] Build status: STARTED
[21:57:07.608] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:23:0) after 4m4s
[22:01:11.633] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:23:0)
[22:01:11.655] Build status: STARTED
[22:01:11.655] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:24:0) after 4m55s
[22:06:06.776] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:24:0)
[22:06:06.801] Build status: STARTED
[22:06:06.801] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:25:0) after 5m31s
[22:11:38.073] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:25:0)
[22:11:38.088] Build status: STARTED
[22:11:38.088] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:26:0) after 5m10s
[22:16:48.229] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:26:0)
[22:16:48.249] Build status: STARTED
[22:16:48.249] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:27:0) after 6m41s
[22:23:29.350] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:27:0)
[22:23:29.369] Build status: STARTED
[22:23:29.369] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:28:0) after 1m9s
[22:24:38.372] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:28:0)
[22:24:38.389] Build status: STARTED
[22:24:38.389] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:29:0) after 2m50s
[22:27:28.410] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:29:0)
[22:27:28.432] Build status: STARTED
[22:27:28.432] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:30:0) after 1m18s
[22:28:46.501] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:30:0)
[22:28:46.516] Build status: STARTED
[22:28:46.516] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-sdk-core-mac-e5a0ec7f:8877124389397374960:31:0) after 2m26s
[22:28:52.317] Received PubSub notification, asking Buildbucket for the build status
[22:28:52.334] Build:
{
"id": "8711694327453032609",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "sdk-core-mac"
},
"createdBy": "project:fuchsia",
"createTime": "2025-06-18T20:18:09.734711536Z",
"startTime": "2025-06-18T20:18:14.383877246Z",
"endTime": "2025-06-18T22:28:52.070287200Z",
"updateTime": "2025-06-18T22:28:52.070287200Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "d3e8ea33a3cb6890599e5cba83526653fdb55d1d",
"ref": "refs/heads/main"
}
}
}
[22:28:52.334] Invocation finished in 2h10m43.838157046s with status SUCCEEDED