[20:22:00.985] New invocation is queued and will start shortly
[20:22:02.019] Starting the invocation (attempt 1)
[20:22:02.049] Popped buildset tag "buildset:commit/gitiles/fuchsia.googlesource.com/integration/+/3c2789ad637234d44daa4ff6f49396bcf59ddb1e"
[20:22:02.049] Popped gitiles commit info from properties and tags
[20:22:02.049] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[20:22:02.049] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[20:22:02.050] Buildbucket request:
{
"requestId": "8901222938683296224",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "terminal.x64-release"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8901222938683296224",
"job": "fuchsia/terminal.x64-release-e5a0ec7f",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "cb29bc6e3cf219994b3063f57c897a5a3138b0c4"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@cb29bc6e3cf219994b3063f57c897a5a3138b0c4",
"title": "cb29bc6e3cf219994b3063f57c897a5a3138b0c4",
"url": "https://fuchsia.googlesource.com/integration/+/cb29bc6e3cf219994b3063f57c897a5a3138b0c4"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "2dbea78f0cd1d264c70883f1855aa8a0277bdfed"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@2dbea78f0cd1d264c70883f1855aa8a0277bdfed",
"title": "2dbea78f0cd1d264c70883f1855aa8a0277bdfed",
"url": "https://fuchsia.googlesource.com/integration/+/2dbea78f0cd1d264c70883f1855aa8a0277bdfed"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "a3a4e5eaa52b1a6d660154304f04cd5711a89a4a"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@a3a4e5eaa52b1a6d660154304f04cd5711a89a4a",
"title": "a3a4e5eaa52b1a6d660154304f04cd5711a89a4a",
"url": "https://fuchsia.googlesource.com/integration/+/a3a4e5eaa52b1a6d660154304f04cd5711a89a4a"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "2ab166a3cf79d82840cc623e96405a22df352549"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@2ab166a3cf79d82840cc623e96405a22df352549",
"title": "2ab166a3cf79d82840cc623e96405a22df352549",
"url": "https://fuchsia.googlesource.com/integration/+/2ab166a3cf79d82840cc623e96405a22df352549"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "8f05ec12d27c0b5230f9dec8425216cff20aa144"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@8f05ec12d27c0b5230f9dec8425216cff20aa144",
"title": "8f05ec12d27c0b5230f9dec8425216cff20aa144",
"url": "https://fuchsia.googlesource.com/integration/+/8f05ec12d27c0b5230f9dec8425216cff20aa144"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "5ba8c4d8905a5f5be94162f5c07cbe8b96d167db"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@5ba8c4d8905a5f5be94162f5c07cbe8b96d167db",
"title": "5ba8c4d8905a5f5be94162f5c07cbe8b96d167db",
"url": "https://fuchsia.googlesource.com/integration/+/5ba8c4d8905a5f5be94162f5c07cbe8b96d167db"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "f0aa41b298c774444a1092c98286b5817f380b50"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@f0aa41b298c774444a1092c98286b5817f380b50",
"title": "f0aa41b298c774444a1092c98286b5817f380b50",
"url": "https://fuchsia.googlesource.com/integration/+/f0aa41b298c774444a1092c98286b5817f380b50"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "987af701b71384fca998bc204afab2159a65fb4c"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@987af701b71384fca998bc204afab2159a65fb4c",
"title": "987af701b71384fca998bc204afab2159a65fb4c",
"url": "https://fuchsia.googlesource.com/integration/+/987af701b71384fca998bc204afab2159a65fb4c"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "7d6ca2f8e680b62a0d1d6ce3dfa8febd92707e12"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@7d6ca2f8e680b62a0d1d6ce3dfa8febd92707e12",
"title": "7d6ca2f8e680b62a0d1d6ce3dfa8febd92707e12",
"url": "https://fuchsia.googlesource.com/integration/+/7d6ca2f8e680b62a0d1d6ce3dfa8febd92707e12"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "d68addb5c14a6f0e9edfd5ee5567c7b299eba1b8"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@d68addb5c14a6f0e9edfd5ee5567c7b299eba1b8",
"title": "d68addb5c14a6f0e9edfd5ee5567c7b299eba1b8",
"url": "https://fuchsia.googlesource.com/integration/+/d68addb5c14a6f0e9edfd5ee5567c7b299eba1b8"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "610f95f7ac884492455bdbcb02b7c87470d2fd24"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@610f95f7ac884492455bdbcb02b7c87470d2fd24",
"title": "610f95f7ac884492455bdbcb02b7c87470d2fd24",
"url": "https://fuchsia.googlesource.com/integration/+/610f95f7ac884492455bdbcb02b7c87470d2fd24"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "38ae050cdabb683b8acacc85860de9d638e88312"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@38ae050cdabb683b8acacc85860de9d638e88312",
"title": "38ae050cdabb683b8acacc85860de9d638e88312",
"url": "https://fuchsia.googlesource.com/integration/+/38ae050cdabb683b8acacc85860de9d638e88312"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "ea994b1f0d418186d9c94e1c0be5b9f8eff5be20"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@ea994b1f0d418186d9c94e1c0be5b9f8eff5be20",
"title": "ea994b1f0d418186d9c94e1c0be5b9f8eff5be20",
"url": "https://fuchsia.googlesource.com/integration/+/ea994b1f0d418186d9c94e1c0be5b9f8eff5be20"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "24b9626ad1797e1e66aab76a36743681343b4685"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@24b9626ad1797e1e66aab76a36743681343b4685",
"title": "24b9626ad1797e1e66aab76a36743681343b4685",
"url": "https://fuchsia.googlesource.com/integration/+/24b9626ad1797e1e66aab76a36743681343b4685"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "a99b7e6679c85955c5b0951d4922a74de20e01db"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@a99b7e6679c85955c5b0951d4922a74de20e01db",
"title": "a99b7e6679c85955c5b0951d4922a74de20e01db",
"url": "https://fuchsia.googlesource.com/integration/+/a99b7e6679c85955c5b0951d4922a74de20e01db"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "56fcf29dca47707252f636ddd539fd7ba5a85052"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@56fcf29dca47707252f636ddd539fd7ba5a85052",
"title": "56fcf29dca47707252f636ddd539fd7ba5a85052",
"url": "https://fuchsia.googlesource.com/integration/+/56fcf29dca47707252f636ddd539fd7ba5a85052"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "e681a33349afdda108679dac6dce0e6adfdf5478"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@e681a33349afdda108679dac6dce0e6adfdf5478",
"title": "e681a33349afdda108679dac6dce0e6adfdf5478",
"url": "https://fuchsia.googlesource.com/integration/+/e681a33349afdda108679dac6dce0e6adfdf5478"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "f54ec63d1300db8b7e78ce1e780269b3749b46a7"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@f54ec63d1300db8b7e78ce1e780269b3749b46a7",
"title": "f54ec63d1300db8b7e78ce1e780269b3749b46a7",
"url": "https://fuchsia.googlesource.com/integration/+/f54ec63d1300db8b7e78ce1e780269b3749b46a7"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "d8a854d28c285df0d1f0321c15b2509814d1e57d"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@d8a854d28c285df0d1f0321c15b2509814d1e57d",
"title": "d8a854d28c285df0d1f0321c15b2509814d1e57d",
"url": "https://fuchsia.googlesource.com/integration/+/d8a854d28c285df0d1f0321c15b2509814d1e57d"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "8075e4d010eda91cd9717bddd6b3077b0f012c5a"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@8075e4d010eda91cd9717bddd6b3077b0f012c5a",
"title": "8075e4d010eda91cd9717bddd6b3077b0f012c5a",
"url": "https://fuchsia.googlesource.com/integration/+/8075e4d010eda91cd9717bddd6b3077b0f012c5a"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "e5a8d6f5227b241238aaf55a4b3cb17533ada9e7"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@e5a8d6f5227b241238aaf55a4b3cb17533ada9e7",
"title": "e5a8d6f5227b241238aaf55a4b3cb17533ada9e7",
"url": "https://fuchsia.googlesource.com/integration/+/e5a8d6f5227b241238aaf55a4b3cb17533ada9e7"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "83ec5b4700516ea70979158db12b8c54933ebaa6"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@83ec5b4700516ea70979158db12b8c54933ebaa6",
"title": "83ec5b4700516ea70979158db12b8c54933ebaa6",
"url": "https://fuchsia.googlesource.com/integration/+/83ec5b4700516ea70979158db12b8c54933ebaa6"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "3c2789ad637234d44daa4ff6f49396bcf59ddb1e"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@3c2789ad637234d44daa4ff6f49396bcf59ddb1e",
"title": "3c2789ad637234d44daa4ff6f49396bcf59ddb1e",
"url": "https://fuchsia.googlesource.com/integration/+/3c2789ad637234d44daa4ff6f49396bcf59ddb1e"
}
]
}
},
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "3c2789ad637234d44daa4ff6f49396bcf59ddb1e",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8901222938683296224"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/terminal.x64-release-e5a0ec7f"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[20:22:02.801] Scheduled build:
{
"id": "8735792876844438593",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "terminal.x64-release"
},
"createdBy": "project:fuchsia",
"createTime": "2024-09-25T20:22:02.116134361Z",
"updateTime": "2024-09-25T20:22:02.116134361Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "3c2789ad637234d44daa4ff6f49396bcf59ddb1e",
"ref": "refs/heads/main"
}
}
}
[20:22:02.801] Task URL: https://cr-buildbucket.appspot.com/build/8735792876844438593
[20:22:02.801] Scheduling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:2:0) after 5m10s
[20:22:03.708] Received PubSub notification, asking Buildbucket for the build status
[20:22:03.735] Build status: SCHEDULED
[20:22:09.202] Received PubSub notification, asking Buildbucket for the build status
[20:22:09.220] Build status: STARTED
[20:27:12.840] Handling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:2:0)
[20:27:12.857] Build status: STARTED
[20:27:12.857] Scheduling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:5:0) after 5m31s
[20:32:43.914] Handling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:5:0)
[20:32:43.934] Build status: STARTED
[20:32:43.934] Scheduling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:6:0) after 6m46s
[20:39:29.964] Handling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:6:0)
[20:39:29.986] Build status: STARTED
[20:39:29.986] Scheduling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:7:0) after 2m20s
[20:41:49.995] Handling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:7:0)
[20:41:50.017] Build status: STARTED
[20:41:50.017] Scheduling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:8:0) after 2m58s
[20:44:48.086] Handling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:8:0)
[20:44:48.110] Build status: STARTED
[20:44:48.110] Scheduling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:9:0) after 1m44s
[20:46:32.165] Handling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:9:0)
[20:46:32.190] Build status: STARTED
[20:46:32.190] Scheduling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:10:0) after 9m16s
[20:55:48.175] Handling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:10:0)
[20:55:48.191] Build status: STARTED
[20:55:48.191] Scheduling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:11:0) after 8m57s
[21:04:45.208] Handling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:11:0)
[21:04:45.226] Build status: STARTED
[21:04:45.226] Scheduling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:12:0) after 4m46s
[21:09:31.244] Handling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:12:0)
[21:09:31.267] Build status: STARTED
[21:09:31.267] Scheduling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:13:0) after 1m26s
[21:10:57.286] Handling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:13:0)
[21:10:57.341] Build status: STARTED
[21:10:57.341] Scheduling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:14:0) after 1m49s
[21:12:46.488] Handling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:14:0)
[21:12:46.515] Build status: STARTED
[21:12:46.515] Scheduling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:15:0) after 9m42s
[21:22:28.608] Handling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:15:0)
[21:22:28.759] Build status: STARTED
[21:22:28.759] Scheduling timer "check-buildbucket-build-status" (fuchsia/terminal.x64-release-e5a0ec7f:8901222938683296224:16:0) after 8m50s
[21:23:02.582] Received PubSub notification, asking Buildbucket for the build status
[21:23:02.599] Build:
{
"id": "8735792876844438593",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "terminal.x64-release"
},
"createdBy": "project:fuchsia",
"createTime": "2024-09-25T20:22:02.116134361Z",
"startTime": "2024-09-25T20:22:08.918484370Z",
"endTime": "2024-09-25T21:23:02.064335882Z",
"updateTime": "2024-09-25T21:23:02.064335882Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "3c2789ad637234d44daa4ff6f49396bcf59ddb1e",
"ref": "refs/heads/main"
}
}
}
[21:23:02.599] Invocation finished in 1h1m1.619463973s with status SUCCEEDED