--Task-- name: Tenant_discovery_and_deployment enabled: True class_name: DiscoverTenantAndDeployOtherWorkloadIfConfiguredTask source_name: controller source_namespace: >default< target_name: controller target_namespace: >default< start: 0.0 stop: None timeout: no timeout loop: False interval: None dependencies: [] wait_for: [] preceding_task: None options: {} group_name: None Current dir: /mnt/disk1/xslou/workshop/lodestar-fork/pyrock ________________________________________________________________________________ [2024-10-16 18:54:50] Tenant_discovery_and_deployment pre : N/A ________________________________________________________________________________ ________________________________________________________________________________ [2024-10-16 18:54:50] Tenant_discovery_and_deployment step1 : N/A ________________________________________________________________________________ 2024-10-16 18:54:50,197 INFO 2024-10-16 18:54:50,197 INFO ******************************** Cleaning up existing namespace ******************************** 2024-10-16 18:54:50,492 INFO 2024-10-16 18:54:50,492 INFO ------------------ Deleting secret agent controller ------------------ 2024-10-16 18:54:50,782 INFO 2024-10-16 18:54:50,782 INFO [loop_until]: kubectl --namespace=xlou delete sac --all 2024-10-16 18:54:50,782 INFO [loop_until]: (max_time=180, interval=5, expected_rc=[0] 2024-10-16 18:54:51,076 INFO [loop_until]: OK (rc = 0) 2024-10-16 18:54:51,076 DEBUG --- stdout --- 2024-10-16 18:54:51,076 DEBUG No resources found 2024-10-16 18:54:51,076 DEBUG --- stderr --- 2024-10-16 18:54:51,076 DEBUG 2024-10-16 18:54:51,076 INFO 2024-10-16 18:54:51,076 INFO ----------------------- Deleting all resources ----------------------- 2024-10-16 18:54:51,076 INFO 2024-10-16 18:54:51,077 INFO [loop_until]: kubectl --namespace=xlou delete all --all --grace-period=0 --force 2024-10-16 18:54:51,077 INFO [loop_until]: (max_time=180, interval=5, expected_rc=[0] 2024-10-16 18:54:53,149 INFO [loop_until]: OK (rc = 0) 2024-10-16 18:54:53,149 DEBUG --- stdout --- 2024-10-16 18:54:53,149 DEBUG pod "lodemon-97dc7bf79-6v2vt" force deleted pod "overseer-0-5b4b859988-8rvk5" force deleted service "overseer-0" force deleted deployment.apps "lodemon" force deleted deployment.apps "overseer-0" force deleted 2024-10-16 18:54:53,149 DEBUG --- stderr --- 2024-10-16 18:54:53,149 DEBUG Warning: Immediate deletion does not wait for confirmation that the running resource has been terminated. The resource may continue to run on the cluster indefinitely. 2024-10-16 18:54:53,149 INFO 2024-10-16 18:54:53,149 INFO [loop_until]: kubectl --namespace xlou get pods | grep "No resources found" 2024-10-16 18:54:53,149 INFO [loop_until]: (max_time=360, interval=10, expected_rc=[0] 2024-10-16 18:54:53,482 INFO [loop_until]: Function succeeded after 0s (rc=0) - failed to find expected output: No resources found - retry 2024-10-16 18:55:03,825 INFO [loop_until]: Function succeeded after 10s (rc=0) - failed to find expected output: No resources found - retry 2024-10-16 18:55:14,171 INFO [loop_until]: Function succeeded after 21s (rc=0) - failed to find expected output: No resources found - retry 2024-10-16 18:55:24,456 INFO [loop_until]: Function succeeded after 31s (rc=0) - expected pattern found 2024-10-16 18:55:24,456 INFO [loop_until]: OK (rc = 0) 2024-10-16 18:55:24,456 DEBUG --- stdout --- 2024-10-16 18:55:24,456 DEBUG 2024-10-16 18:55:24,456 DEBUG --- stderr --- 2024-10-16 18:55:24,456 DEBUG No resources found in xlou namespace. 2024-10-16 18:55:24,456 INFO 2024-10-16 18:55:24,456 INFO ------------------------- Deleting configmap ------------------------- 2024-10-16 18:55:24,456 INFO 2024-10-16 18:55:24,456 INFO [loop_until]: kubectl --namespace=xlou get configmap --output jsonpath={.items[*].metadata.name} 2024-10-16 18:55:24,456 INFO [loop_until]: (max_time=180, interval=5, expected_rc=[0] 2024-10-16 18:55:24,756 INFO [loop_until]: OK (rc = 0) 2024-10-16 18:55:24,756 DEBUG --- stdout --- 2024-10-16 18:55:24,756 DEBUG kube-root-ca.crt lodemon-config lodemon-deployments overseer-config-0 2024-10-16 18:55:24,756 DEBUG --- stderr --- 2024-10-16 18:55:24,756 DEBUG 2024-10-16 18:55:24,756 INFO 2024-10-16 18:55:24,756 INFO [loop_until]: kubectl --namespace=xlou delete configmap kube-root-ca.crt --ignore-not-found 2024-10-16 18:55:24,756 INFO [loop_until]: (max_time=180, interval=5, expected_rc=[0] 2024-10-16 18:55:25,141 INFO [loop_until]: OK (rc = 0) 2024-10-16 18:55:25,142 DEBUG --- stdout --- 2024-10-16 18:55:25,142 DEBUG configmap "kube-root-ca.crt" deleted 2024-10-16 18:55:25,142 DEBUG --- stderr --- 2024-10-16 18:55:25,142 DEBUG 2024-10-16 18:55:25,142 INFO 2024-10-16 18:55:25,142 INFO [loop_until]: kubectl --namespace=xlou delete configmap lodemon-config --ignore-not-found 2024-10-16 18:55:25,142 INFO [loop_until]: (max_time=180, interval=5, expected_rc=[0] 2024-10-16 18:55:25,525 INFO [loop_until]: OK (rc = 0) 2024-10-16 18:55:25,525 DEBUG --- stdout --- 2024-10-16 18:55:25,525 DEBUG configmap "lodemon-config" deleted 2024-10-16 18:55:25,525 DEBUG --- stderr --- 2024-10-16 18:55:25,525 DEBUG 2024-10-16 18:55:25,526 INFO 2024-10-16 18:55:25,526 INFO [loop_until]: kubectl --namespace=xlou delete configmap lodemon-deployments --ignore-not-found 2024-10-16 18:55:25,526 INFO [loop_until]: (max_time=180, interval=5, expected_rc=[0] 2024-10-16 18:55:25,907 INFO [loop_until]: OK (rc = 0) 2024-10-16 18:55:25,907 DEBUG --- stdout --- 2024-10-16 18:55:25,907 DEBUG configmap "lodemon-deployments" deleted 2024-10-16 18:55:25,907 DEBUG --- stderr --- 2024-10-16 18:55:25,907 DEBUG 2024-10-16 18:55:25,908 INFO 2024-10-16 18:55:25,908 INFO [loop_until]: kubectl --namespace=xlou delete configmap overseer-config-0 --ignore-not-found 2024-10-16 18:55:25,908 INFO [loop_until]: (max_time=180, interval=5, expected_rc=[0] 2024-10-16 18:55:26,290 INFO [loop_until]: OK (rc = 0) 2024-10-16 18:55:26,290 DEBUG --- stdout --- 2024-10-16 18:55:26,290 DEBUG configmap "overseer-config-0" deleted 2024-10-16 18:55:26,290 DEBUG --- stderr --- 2024-10-16 18:55:26,290 DEBUG 2024-10-16 18:55:26,290 INFO 2024-10-16 18:55:26,290 INFO --------------------------- Deleting secret --------------------------- 2024-10-16 18:55:26,290 INFO 2024-10-16 18:55:26,290 INFO [loop_until]: kubectl --namespace=xlou get secret **** 2024-10-16 18:55:26,290 INFO [loop_until]: (max_time=180, interval=5, expected_rc=[0] 2024-10-16 18:55:26,580 INFO [loop_until]: OK (rc = 0) 2024-10-16 18:55:26,581 DEBUG --- stdout --- 2024-10-16 18:55:26,581 DEBUG 2024-10-16 18:55:26,581 DEBUG --- stderr --- 2024-10-16 18:55:26,581 DEBUG 2024-10-16 18:55:26,581 INFO 2024-10-16 18:55:26,581 INFO -------------------------- Deleting ingress -------------------------- 2024-10-16 18:55:26,581 INFO 2024-10-16 18:55:26,581 INFO [loop_until]: kubectl --namespace=xlou get ingress --output jsonpath={.items[*].metadata.name} 2024-10-16 18:55:26,581 INFO [loop_until]: (max_time=180, interval=5, expected_rc=[0] 2024-10-16 18:55:26,869 INFO [loop_until]: OK (rc = 0) 2024-10-16 18:55:26,869 DEBUG --- stdout --- 2024-10-16 18:55:26,869 DEBUG overseer-0 2024-10-16 18:55:26,869 DEBUG --- stderr --- 2024-10-16 18:55:26,869 DEBUG 2024-10-16 18:55:26,870 INFO 2024-10-16 18:55:26,870 INFO [loop_until]: kubectl --namespace=xlou delete ingress overseer-0 --ignore-not-found 2024-10-16 18:55:26,870 INFO [loop_until]: (max_time=180, interval=5, expected_rc=[0] 2024-10-16 18:55:27,265 INFO [loop_until]: OK (rc = 0) 2024-10-16 18:55:27,265 DEBUG --- stdout --- 2024-10-16 18:55:27,265 DEBUG ingress.networking.k8s.io "overseer-0" deleted 2024-10-16 18:55:27,265 DEBUG --- stderr --- 2024-10-16 18:55:27,265 DEBUG 2024-10-16 18:55:27,265 INFO 2024-10-16 18:55:27,265 INFO ---------------------------- Deleting pvc ---------------------------- 2024-10-16 18:55:27,265 INFO 2024-10-16 18:55:27,265 INFO [loop_until]: kubectl --namespace=xlou get pvc --output jsonpath={.items[*].metadata.name} 2024-10-16 18:55:27,265 INFO [loop_until]: (max_time=180, interval=5, expected_rc=[0] 2024-10-16 18:55:27,559 INFO [loop_until]: OK (rc = 0) 2024-10-16 18:55:27,559 DEBUG --- stdout --- 2024-10-16 18:55:27,559 DEBUG overseer-0 2024-10-16 18:55:27,559 DEBUG --- stderr --- 2024-10-16 18:55:27,560 DEBUG 2024-10-16 18:55:27,560 INFO 2024-10-16 18:55:27,560 INFO [loop_until]: kubectl --namespace=xlou delete pvc overseer-0 --ignore-not-found 2024-10-16 18:55:27,560 INFO [loop_until]: (max_time=180, interval=5, expected_rc=[0] 2024-10-16 18:55:27,941 INFO [loop_until]: OK (rc = 0) 2024-10-16 18:55:27,941 DEBUG --- stdout --- 2024-10-16 18:55:27,941 DEBUG persistentvolumeclaim "overseer-0" deleted 2024-10-16 18:55:27,941 DEBUG --- stderr --- 2024-10-16 18:55:27,941 DEBUG 2024-10-16 18:55:27,942 INFO 2024-10-16 18:55:27,942 INFO [loop_until]: kubectl --namespace=xlou delete pv ds-backup-xlou --ignore-not-found 2024-10-16 18:55:27,942 INFO [loop_until]: (max_time=180, interval=5, expected_rc=[0] 2024-10-16 18:55:28,328 INFO [loop_until]: OK (rc = 0) 2024-10-16 18:55:28,329 DEBUG --- stdout --- 2024-10-16 18:55:28,329 DEBUG 2024-10-16 18:55:28,329 DEBUG --- stderr --- 2024-10-16 18:55:28,329 DEBUG Warning: deleting cluster-scoped resources, not scoped to the provided namespace 2024-10-16 18:55:28,329 INFO 2024-10-16 18:55:28,329 INFO ----------------- Deleting admin clusterrolebindings ----------------- 2024-10-16 18:55:28,329 INFO 2024-10-16 18:55:28,329 INFO [loop_until]: kubectl get clusterrolebinding --output jsonpath="{range .items[?(@.subjects[0].namespace=='xlou')]}{.metadata.name} {end}" 2024-10-16 18:55:28,329 INFO [loop_until]: (max_time=180, interval=5, expected_rc=[0] 2024-10-16 18:55:28,911 INFO [loop_until]: OK (rc = 0) 2024-10-16 18:55:28,911 DEBUG --- stdout --- 2024-10-16 18:55:28,911 DEBUG k8s-svc-acct-crb-xlou k8s-svc-acct-crb-xlou-0 2024-10-16 18:55:28,911 DEBUG --- stderr --- 2024-10-16 18:55:28,911 DEBUG 2024-10-16 18:55:28,911 INFO Deleting clusterrolebinding k8s-svc-acct-crb-xlou associated with xlou namespace 2024-10-16 18:55:28,911 INFO 2024-10-16 18:55:28,911 INFO [loop_until]: kubectl delete clusterrolebinding k8s-svc-acct-crb-xlou 2024-10-16 18:55:28,911 INFO [loop_until]: (max_time=180, interval=5, expected_rc=[0] 2024-10-16 18:55:29,299 INFO [loop_until]: OK (rc = 0) 2024-10-16 18:55:29,299 DEBUG --- stdout --- 2024-10-16 18:55:29,299 DEBUG clusterrolebinding.rbac.authorization.k8s.io "k8s-svc-acct-crb-xlou" deleted 2024-10-16 18:55:29,299 DEBUG --- stderr --- 2024-10-16 18:55:29,299 DEBUG 2024-10-16 18:55:29,299 INFO Deleting clusterrolebinding k8s-svc-acct-crb-xlou-0 associated with xlou namespace 2024-10-16 18:55:29,299 INFO 2024-10-16 18:55:29,299 INFO [loop_until]: kubectl delete clusterrolebinding k8s-svc-acct-crb-xlou-0 2024-10-16 18:55:29,299 INFO [loop_until]: (max_time=180, interval=5, expected_rc=[0] 2024-10-16 18:55:29,683 INFO [loop_until]: OK (rc = 0) 2024-10-16 18:55:29,683 DEBUG --- stdout --- 2024-10-16 18:55:29,683 DEBUG clusterrolebinding.rbac.authorization.k8s.io "k8s-svc-acct-crb-xlou-0" deleted 2024-10-16 18:55:29,683 DEBUG --- stderr --- 2024-10-16 18:55:29,683 DEBUG 2024-10-16 18:55:29,683 INFO 2024-10-16 18:55:29,683 INFO ------------------------- Deleting namespace ------------------------- 2024-10-16 18:55:29,975 INFO 2024-10-16 18:55:29,975 INFO [loop_until]: kubectl delete namespaces xlou --grace-period=0 --force 2024-10-16 18:55:29,975 INFO [loop_until]: (max_time=360, interval=5, expected_rc=[0] 2024-10-16 18:55:35,642 INFO [loop_until]: OK (rc = 0) 2024-10-16 18:55:35,642 DEBUG --- stdout --- 2024-10-16 18:55:35,642 DEBUG namespace "xlou" force deleted 2024-10-16 18:55:35,642 DEBUG --- stderr --- 2024-10-16 18:55:35,642 DEBUG Warning: Immediate deletion does not wait for confirmation that the running resource has been terminated. The resource may continue to run on the cluster indefinitely. 2024-10-16 18:55:51,445 INFO 2024-10-16 18:55:51,445 INFO ************************************* Creating deployment ************************************* 2024-10-16 18:55:51,445 INFO Creating IDC type deployment for stack 2024-10-16 18:55:51,445 INFO 2024-10-16 18:55:51,445 INFO ************************************** Discovering tenant ************************************** 2024-10-16 18:55:51,445 INFO 2024-10-16 18:55:51,445 INFO ************************ Connecting to cluster of tenant perf-benchmark ************************ 2024-10-16 18:55:51,445 INFO Preferred resolution method: using gcloud projects list command to retrieve tenant project ID 2024-10-16 18:55:51,445 INFO 2024-10-16 18:55:51,445 INFO ---------- Retrieving project info for tenant perf-benchmark ---------- 2024-10-16 18:55:51,445 DEBUG Displays gcloud account and the one in use (helpful for debugging) 2024-10-16 18:55:51,445 INFO 2024-10-16 18:55:51,445 INFO [run_command]: gcloud auth list 2024-10-16 18:55:52,043 INFO [run_command]: OK (rc = 0 - expected to be in [0]) 2024-10-16 18:55:52,043 DEBUG --- stdout --- 2024-10-16 18:55:52,043 DEBUG Credentialed Accounts ACTIVE ACCOUNT 941969722215-compute@developer.gserviceaccount.com * xiaosong.lou@pingidentity.com 2024-10-16 18:55:52,043 DEBUG --- stderr --- 2024-10-16 18:55:52,043 DEBUG To set the active account, run: $ gcloud config set account `ACCOUNT` 2024-10-16 18:55:52,043 INFO 2024-10-16 18:55:52,044 INFO Filter projects to retrieve the one associated to tenant perf-benchmark 2024-10-16 18:55:52,044 INFO 2024-10-16 18:55:52,044 INFO [run_command]: gcloud projects list --filter=name~^.*perf-benchmark$ --format=json 2024-10-16 18:55:56,587 INFO [run_command]: OK (rc = 0 - expected to be in [0]) 2024-10-16 18:55:56,587 DEBUG --- stdout --- 2024-10-16 18:55:56,587 DEBUG [] 2024-10-16 18:55:56,587 DEBUG --- stderr --- 2024-10-16 18:55:56,587 DEBUG 2024-10-16 18:55:56,587 INFO 2024-10-16 18:55:56,587 ERROR Error while loading k8s context for tenant perf-benchmark: No projects returned by command ran with active gcloud account. Ensure active account has access to the tenant project. Command was: cmd=gcloud projects list --filter=name~^.*perf-benchmark$ --format=json, rc=0, stderr=, stdout=[], pid=None, popen=None 2024-10-16 18:55:56,587 WARNING Tenant project not found using projects list, no tenant project ID provided so consider we do not have access to the tenant project 2024-10-16 18:55:56,587 WARNING Cannot discover properties of tenant perf-benchmark because cannot access GKE project (discovery status is project not found) 2024-10-16 18:55:56,589 WARNING No k8s context for tenant perf-benchmark because cannot access GKE project (discovery status is project not found) 2024-10-16 18:55:56,693 INFO 2024-10-16 18:55:56,693 INFO *************************** Livecheck stage: After tenant discovery *************************** 2024-10-16 18:55:56,693 INFO 2024-10-16 18:55:56,693 INFO ------------------------ Running AM livecheck ------------------------ 2024-10-16 18:55:56,693 INFO Livecheck to https://openam-perf-benchmark.forgeblocks.com/am/json/health/ready 2024-10-16 18:55:56,694 INFO [http_cmd]: curl --insecure -L --request GET "https://openam-perf-benchmark.forgeblocks.com/am/json/health/ready" 2024-10-16 18:55:56,791 INFO [http_cmd]: http status code OK 2024-10-16 18:55:56,791 DEBUG --- status code --- 2024-10-16 18:55:56,791 DEBUG http status code is 200 (expected 200) 2024-10-16 18:55:56,791 DEBUG --- http response --- 2024-10-16 18:55:56,791 DEBUG 2024-10-16 18:55:56,791 INFO 2024-10-16 18:55:56,791 INFO ------------------------ Running IDM livecheck ------------------------ 2024-10-16 18:55:56,791 INFO Livecheck to https://openam-perf-benchmark.forgeblocks.com/openidm/info/ping 2024-10-16 18:55:56,792 INFO [http_cmd]: curl --insecure -L --request GET "https://openam-perf-benchmark.forgeblocks.com/openidm/info/ping" 2024-10-16 18:55:56,842 INFO [http_cmd]: http status code OK 2024-10-16 18:55:56,842 DEBUG --- status code --- 2024-10-16 18:55:56,842 DEBUG http status code is 200 (expected 200) 2024-10-16 18:55:56,842 DEBUG --- http response --- 2024-10-16 18:55:56,842 DEBUG { "_id": "", "_rev": "", "shortDesc": "OpenIDM ready", "state": "ACTIVE_READY" } 2024-10-16 18:55:56,842 INFO Create new LoginSession for user "xiaosong.lou@pingidentity.com" 2024-10-16 18:55:56,842 INFO [LoginSession] Get "access_token" token for user "xiaosong.lou@pingidentity.com" 2024-10-16 18:55:56,842 INFO [LoginSession] Obtaining new "access_token" token from server because it was not obtained yet for the user 2024-10-16 18:55:56,842 INFO [LoginSession] Get "token_id" token for user "xiaosong.lou@pingidentity.com" 2024-10-16 18:55:56,842 INFO [LoginSession] Obtaining new "token_id" token from server because it was not obtained yet for the user 2024-10-16 18:55:56,842 INFO Authenticate user xiaosong.lou@pingidentity.com via REST 2024-10-16 18:55:56,843 INFO [http_cmd]: curl --insecure -L --request POST "https://openam-perf-benchmark.forgeblocks.com/am/json/authenticate?realm=/" 2024-10-16 18:55:56,972 INFO [http_cmd]: http status code OK 2024-10-16 18:55:56,972 DEBUG --- status code --- 2024-10-16 18:55:56,972 DEBUG http status code is 200 (expected 200) 2024-10-16 18:55:56,972 DEBUG --- http response --- 2024-10-16 18:55:56,972 DEBUG [print_head_tail]: Print head (10 lines) and tail (10 lines) of input string (83 lines): 2024-10-16 18:55:56,972 DEBUG ----- output ----- 2024-10-16 18:55:56,972 DEBUG { 2024-10-16 18:55:56,972 DEBUG "authId": "eyJ0eXAiOiJKV1QiLCJhbGciOiJIUzI1NiJ9.eyJ3aGl0ZWxpc3Qtc3RhdGUiOiIzYTdmOTdmNS05MTZiLTQ4YTEtODcwNi04NWFlMWIwNDEwNzQiLCJvdGsiOiJkcm9oM25ycjRycG1xMzN1MXVkcDk5cjhxdSIsInJlYWxtIjoiLyIsInNlc3Npb25JZCI6IipBQUpUU1FBQ01ESUFCSFI1Y0dVQUNFcFhWRjlCVlZSSUFBSlRNUUFDTURFLipleUowZVhBaU9pSktWMVFpTENKamRIa2lPaUpLVjFRaUxDSmhiR2NpT2lKSVV6STFOaUo5LlpYbEtNR1ZZUVdsUGFVcExWakZSYVV4RFNteGliVTFwVDJsS1FrMVVTVFJSTUVwRVRGVm9WRTFxVlRKSmFYZHBXVmQ0YmtscWIybGFSMng1U1c0d0xpNWxOakpNV2tJMmMweG1RV0Y1ZURSYVNFWm9hWEYzTGpGWVVXVmhhekJQU1VkWFprRkxWM1pCWnpSVlRWaG1jbVpDU1ROMWVFUnNiMVl4TWpCelNYWlJhbEZtYVcxRlEwWkdkR1ExV0hWbGVURkRhRTVYWXpkNFdqRldXR2wyY0cxVll6Rm1WazVxZGpWdE1qUkpSSEpFTld0RlF6Y3lMVmhPUzIxR1JUVkdiWG8xWnpWWFZrTXlNazVFTFRsMmIxOXJVRWxMVWtGbE1USm9USGswVkRseWFtWnVTbTFqYjNCa2RuTlNWVWhIUzA5alRHRm9ZV2xsTW5KZllqRlpTRWRKYldJeFR6QTFXSGw2UWxoMExWb3pYMjVZTkhaa2NFMDVWbEl6ZFVOVVJuVnBNVFJhWldRdFUwSmZhSFJWWlV0SFoybHpNRXRIV201aGVVVmxRMGhMYTFNd1ZrSkVWM2RvYms5TFZsaGhaSHBLVTNGQllYVkxVMWRGY0dwRWFrTnlka0pCTW1kNmEwSmtNRGx3Wm14c1NqWTFka2RzV1d4emJFOVlXRkI0UmxvMVltbFRlRVpTUTNsWFFVZEVTalZJWDJKdWVITlFPSEZOUzJ0WFdtZExVRFJTTkVSM2RXUnNjR0YxZW5wbk1tdEJZMDVHYzNVdFVHNWpRWEJPY2xCc1JFcHFNVEpwVkRocWFXSTFWekpGWHpsVmVIZHdjMlpHYTFjMmFsWllPVFpZYTFJeFF6VkxaMVp2T1VGcmNVYzNjMWhKVlVreVJXVkdWRGszWVVsRVl5MUtTbEpYTTJwWVFrWk1lSEE1VEdGT1pXdGFZazExUkdKR1lqVlVOVE55UW5kVE5HZFJUbFpuWDNGSVgweGZTVWM1YjJnMVJFSTJUWEZ4VTFoWWFsSkdTbFkwUXpkSFNuZ3RhVFJQZDI1dWJHWnRWVWg1UWxkNVFYSkpSV3BZZUVaS1FXcDBXVXBEWjNGMU5IRmpWSEF0UWtsRVUzRnRURkJLUmpZeVZqTnZjell5U21oelVWZzBZekJYWlc5eWFXMUtWbU50Vm5GNlQwRnBYM05SYldKM2NWQnhaSHBwY201RVUzZHBPWGh5VlY5clFURXROVGxGWkVoRlpUZGhNM05OVVdOTlptZ3hRbWhVYlc0M2IwbFZRVXd4YVZWVE1qTmxNbk5WY1Y4d1VWbG1VRm80VlZOS00wVTRTMjlDVUU5TlQzSk5hWFJHY0ZWV00weEtTRmRPZDJ4Sk5GaGhZVWxoTTNCdFdYSTBjakk1WWpaVmQwb3RiM2xwUkZKdFYxSm1XVmR0WVVKNGVIUktjV3gyY205SWFEbHNWa0ZUVFdGSk9WbFRaekk0V2tkUk5rcHplbVJEYTB4WFVWTTFkMjVqYzFsME1IWnRVVUl5UWsxeVZrcFJaWFF5UW1waVIwWlRVRkpQYVVsQmNtcHhVV3ByVkc5QmEwTlpObkpyWkdOdlpFVnRPWHBZYUdkT2QxZERkbTFPV1RkZmNWcExSVE5hWDFCUmVrNVNTRGcwWkdsRWFrNUJTa2N5VG5kUUxUTmhaRnBWYVUxc1owOXNXVVYyV21KSVJYZDBTVE40UkVWakxUQnhkVGxuWkRCQmIyTXRRVTE1ZG1SdFkyOURTVmR5UVRVMmFUZzNXVFZwTkhkV1JEVTJXVUpVYVRaTWNtNTNURjk1U0dWNlVEQnpabmhsY1daNmVYTTBXVnBYZWpJeFducHhhRlpEUjBSRGMxRkNlbGM0TVZacmVsZFVWRFZaT0VsQlJVZExNbmxwYTJSSFIzcGxUMFZIVUY4NVRsWldWbkJvZVU5Qk5HSXdhM051Y0Y5RFFtWkllV3cyUldoV1oyNUljWEYzWjNOTVltWnlaRXRzWTJsQmF6WXhWWHBxUldSYVUyeFBkR05oZW5kZk5VTjVhREE1TjAxdGJrdzNUek00U1VaWExXeDZabVpwVDBScmRIaG5ORlV5V2xwS09EbHNSR1ZQYVU1bVdGZHRTa28wT1RWbWFWTkdRV0pJVmpoTlN6bGlVWGRQZGtWbWFGODJXbWx0TjNWcVRqTmpNRGx5U1Vrd2VtVjFjV1pDVldoc1VGTnZUMjV3Wm5jeFozQTNiemxNYjB0clZrcFdhR1F0UjBocGJXZG1iWGR4VlZKU1dFdzVXWE4wV1ZWSU4xRTRTRmhYVVdFNGR6VkZRMUpRWmsxR2NtWmtNR2hhTkZGQ2ExcHNZVFJKTjJ0WGIzcHpNa2d5TVZaR2RraDZkSEJVWWpCT2VtWTNkVEYzUW1jeFNqTmFZbmxHZVROdmMzcENiazl3YldOMGJsQnVTVGhLUjBGa2JXeHFOMWhTYjBoa1dHZGxkVjlXVWpGd1pYUm1RVXRxUkhsb01VMU1TVXBUYTFwQ2NWVTFZMng2WDAxYWIzTnVkbFJuTlV0VVgyVlFaSE5HVmxsZmN6RlpUbkZSUVhGR00ybGpkbkpEZVdaU1drWnlWbkZ1VTNoYVF6ZGhRak5wYURCUmNrSklSbmRZV214Qk5sZDRRMlpNU2tWUlZFOU9Ra3B0VEMxeGIwY3RWak5uUm10dVRuZFJTVEZKV21aRE5tRmZNMnRKVFhocWVrbERjV1YyVVVsNlowTXdjVFJ4VTBvdFpUYzBPR3cwVUdkVWEwUXhURk5KTlZRelZYUjVSbEF3Y0V4clMxZFpSME5CZG05WVgzZEZaRlZJWjJOV1lqZG5VSGc1UjFkRFZqTTNhMkk1UVdaS2VVYzRNMjVSU21aTFJWQkNSV0pmZVVkcU5HZ3lPR05IVlhNeVEzQjFRbWhvTURsM1pVWjNORWhCTFdwT01GOXpYMEpzUkdNd1NHcFVMVmRXYmkwdFpUWk1Nbmx5VUhOWmNGWmhabk40Y2tkS1FURmljRzFuVHpGM01sVnhkMHhJTUZSbWNVNWxUVVkzVXpKRlYxaEVVWG94UWxOM1QyeHpkelUxWm1wbmNpMTVWMjlHUlV3eGVXcG1aaTFvWDJjeVZHbDFORWcyTW5oaVVTNU5VRFU1ZGpJMU1sQnZhbEZXU1RZMVZYUXpXa1JSLnJzSm1QX29kcU1pLWRCY0s5YWNUckN2VlR6ZXJ4b3kxbjlDWlRhTmlaeG8iLCJleHAiOjE3MjkxOTEzNTYsImlhdCI6MTcyOTEwNDk1Nn0.OmSXiw1A26w01Q98tADCECA5vIGNvBDk1hCVPzwIDQU", 2024-10-16 18:55:56,972 DEBUG "callbacks": [ 2024-10-16 18:55:56,972 DEBUG { 2024-10-16 18:55:56,972 DEBUG "type": "TextOutputCallback", 2024-10-16 18:55:56,972 DEBUG "output": [ 2024-10-16 18:55:56,972 DEBUG { 2024-10-16 18:55:56,972 DEBUG "name": "message", 2024-10-16 18:55:56,972 DEBUG "value": "Loading..." 2024-10-16 18:55:56,972 DEBUG }, 2024-10-16 18:55:56,972 DEBUG 2024-10-16 18:55:56,972 DEBUG 2024-10-16 18:55:56,972 DEBUG 2024-10-16 18:55:56,972 DEBUG [...] 2024-10-16 18:55:56,972 DEBUG 2024-10-16 18:55:56,972 DEBUG 2024-10-16 18:55:56,972 DEBUG 2024-10-16 18:55:56,972 DEBUG "value": "var setupPage = function() { var skipInputElem = document.getElementById(\"skip-input-563\"); var messageElem; document.getElementsByClassName(\"callback-component\").forEach( function (e) { var m = e.firstElementChild; if (m.firstChild && m.firstChild.nodeName == \"#text\" && m.firstChild.nodeValue.trim() == \"Loading...\") { messageElem = m; } } ); if (!skipInputElem || !messageElem) { return setTimeout(setupPage, 50); } var skipContainer = document.createElement(\"div\"); skipContainer.style = \"width:100%\"; skipContainer.innerHTML = \"\"; skipInputElem.parentNode.append(skipContainer); messageElem.align = \"center\"; messageElem.innerHTML = \"

Set up 2-step verification

To protect your account, add a second
authentication method.
Starting April 2, 2024, you must sign in using
2-step verification. Learn more here.
\"; var bindSkipLink = function() { document.getElementById(\"skip-link-563\").onclick = function() { skipInputElem.value = \"Skip\"; document.getElementById(\"loginButton_0\").click(); return false; }; }; setTimeout(bindSkipLink, 100);};setupPage();" 2024-10-16 18:55:56,972 DEBUG }, 2024-10-16 18:55:56,973 DEBUG { 2024-10-16 18:55:56,973 DEBUG "name": "messageType", 2024-10-16 18:55:56,973 DEBUG "value": "4" 2024-10-16 18:55:56,973 DEBUG } 2024-10-16 18:55:56,973 DEBUG ] 2024-10-16 18:55:56,973 DEBUG } 2024-10-16 18:55:56,973 DEBUG ] 2024-10-16 18:55:56,973 DEBUG } 2024-10-16 18:55:56,973 INFO [http_cmd]: curl --header "Content-Type: application/json" --header "Accept-API-Version: protocol=2.0,resource=1.0" --insecure -L --request POST --cookie "amlbcookie=01" --data '{"authId": "eyJ0eXAiOiJKV1QiLCJhbGciOiJIUzI1NiJ9.eyJ3aGl0ZWxpc3Qtc3RhdGUiOiIzYTdmOTdmNS05MTZiLTQ4YTEtODcwNi04NWFlMWIwNDEwNzQiLCJvdGsiOiJkcm9oM25ycjRycG1xMzN1MXVkcDk5cjhxdSIsInJlYWxtIjoiLyIsInNlc3Npb25JZCI6IipBQUpUU1FBQ01ESUFCSFI1Y0dVQUNFcFhWRjlCVlZSSUFBSlRNUUFDTURFLipleUowZVhBaU9pSktWMVFpTENKamRIa2lPaUpLVjFRaUxDSmhiR2NpT2lKSVV6STFOaUo5LlpYbEtNR1ZZUVdsUGFVcExWakZSYVV4RFNteGliVTFwVDJsS1FrMVVTVFJSTUVwRVRGVm9WRTFxVlRKSmFYZHBXVmQ0YmtscWIybGFSMng1U1c0d0xpNWxOakpNV2tJMmMweG1RV0Y1ZURSYVNFWm9hWEYzTGpGWVVXVmhhekJQU1VkWFprRkxWM1pCWnpSVlRWaG1jbVpDU1ROMWVFUnNiMVl4TWpCelNYWlJhbEZtYVcxRlEwWkdkR1ExV0hWbGVURkRhRTVYWXpkNFdqRldXR2wyY0cxVll6Rm1WazVxZGpWdE1qUkpSSEpFTld0RlF6Y3lMVmhPUzIxR1JUVkdiWG8xWnpWWFZrTXlNazVFTFRsMmIxOXJVRWxMVWtGbE1USm9USGswVkRseWFtWnVTbTFqYjNCa2RuTlNWVWhIUzA5alRHRm9ZV2xsTW5KZllqRlpTRWRKYldJeFR6QTFXSGw2UWxoMExWb3pYMjVZTkhaa2NFMDVWbEl6ZFVOVVJuVnBNVFJhWldRdFUwSmZhSFJWWlV0SFoybHpNRXRIV201aGVVVmxRMGhMYTFNd1ZrSkVWM2RvYms5TFZsaGhaSHBLVTNGQllYVkxVMWRGY0dwRWFrTnlka0pCTW1kNmEwSmtNRGx3Wm14c1NqWTFka2RzV1d4emJFOVlXRkI0UmxvMVltbFRlRVpTUTNsWFFVZEVTalZJWDJKdWVITlFPSEZOUzJ0WFdtZExVRFJTTkVSM2RXUnNjR0YxZW5wbk1tdEJZMDVHYzNVdFVHNWpRWEJPY2xCc1JFcHFNVEpwVkRocWFXSTFWekpGWHpsVmVIZHdjMlpHYTFjMmFsWllPVFpZYTFJeFF6VkxaMVp2T1VGcmNVYzNjMWhKVlVreVJXVkdWRGszWVVsRVl5MUtTbEpYTTJwWVFrWk1lSEE1VEdGT1pXdGFZazExUkdKR1lqVlVOVE55UW5kVE5HZFJUbFpuWDNGSVgweGZTVWM1YjJnMVJFSTJUWEZ4VTFoWWFsSkdTbFkwUXpkSFNuZ3RhVFJQZDI1dWJHWnRWVWg1UWxkNVFYSkpSV3BZZUVaS1FXcDBXVXBEWjNGMU5IRmpWSEF0UWtsRVUzRnRURkJLUmpZeVZqTnZjell5U21oelVWZzBZekJYWlc5eWFXMUtWbU50Vm5GNlQwRnBYM05SYldKM2NWQnhaSHBwY201RVUzZHBPWGh5VlY5clFURXROVGxGWkVoRlpUZGhNM05OVVdOTlptZ3hRbWhVYlc0M2IwbFZRVXd4YVZWVE1qTmxNbk5WY1Y4d1VWbG1VRm80VlZOS00wVTRTMjlDVUU5TlQzSk5hWFJHY0ZWV00weEtTRmRPZDJ4Sk5GaGhZVWxoTTNCdFdYSTBjakk1WWpaVmQwb3RiM2xwUkZKdFYxSm1XVmR0WVVKNGVIUktjV3gyY205SWFEbHNWa0ZUVFdGSk9WbFRaekk0V2tkUk5rcHplbVJEYTB4WFVWTTFkMjVqYzFsME1IWnRVVUl5UWsxeVZrcFJaWFF5UW1waVIwWlRVRkpQYVVsQmNtcHhVV3ByVkc5QmEwTlpObkpyWkdOdlpFVnRPWHBZYUdkT2QxZERkbTFPV1RkZmNWcExSVE5hWDFCUmVrNVNTRGcwWkdsRWFrNUJTa2N5VG5kUUxUTmhaRnBWYVUxc1owOXNXVVYyV21KSVJYZDBTVE40UkVWakxUQnhkVGxuWkRCQmIyTXRRVTE1ZG1SdFkyOURTVmR5UVRVMmFUZzNXVFZwTkhkV1JEVTJXVUpVYVRaTWNtNTNURjk1U0dWNlVEQnpabmhsY1daNmVYTTBXVnBYZWpJeFducHhhRlpEUjBSRGMxRkNlbGM0TVZacmVsZFVWRFZaT0VsQlJVZExNbmxwYTJSSFIzcGxUMFZIVUY4NVRsWldWbkJvZVU5Qk5HSXdhM051Y0Y5RFFtWkllV3cyUldoV1oyNUljWEYzWjNOTVltWnlaRXRzWTJsQmF6WXhWWHBxUldSYVUyeFBkR05oZW5kZk5VTjVhREE1TjAxdGJrdzNUek00U1VaWExXeDZabVpwVDBScmRIaG5ORlV5V2xwS09EbHNSR1ZQYVU1bVdGZHRTa28wT1RWbWFWTkdRV0pJVmpoTlN6bGlVWGRQZGtWbWFGODJXbWx0TjNWcVRqTmpNRGx5U1Vrd2VtVjFjV1pDVldoc1VGTnZUMjV3Wm5jeFozQTNiemxNYjB0clZrcFdhR1F0UjBocGJXZG1iWGR4VlZKU1dFdzVXWE4wV1ZWSU4xRTRTRmhYVVdFNGR6VkZRMUpRWmsxR2NtWmtNR2hhTkZGQ2ExcHNZVFJKTjJ0WGIzcHpNa2d5TVZaR2RraDZkSEJVWWpCT2VtWTNkVEYzUW1jeFNqTmFZbmxHZVROdmMzcENiazl3YldOMGJsQnVTVGhLUjBGa2JXeHFOMWhTYjBoa1dHZGxkVjlXVWpGd1pYUm1RVXRxUkhsb01VMU1TVXBUYTFwQ2NWVTFZMng2WDAxYWIzTnVkbFJuTlV0VVgyVlFaSE5HVmxsZmN6RlpUbkZSUVhGR00ybGpkbkpEZVdaU1drWnlWbkZ1VTNoYVF6ZGhRak5wYURCUmNrSklSbmRZV214Qk5sZDRRMlpNU2tWUlZFOU9Ra3B0VEMxeGIwY3RWak5uUm10dVRuZFJTVEZKV21aRE5tRmZNMnRKVFhocWVrbERjV1YyVVVsNlowTXdjVFJ4VTBvdFpUYzBPR3cwVUdkVWEwUXhURk5KTlZRelZYUjVSbEF3Y0V4clMxZFpSME5CZG05WVgzZEZaRlZJWjJOV1lqZG5VSGc1UjFkRFZqTTNhMkk1UVdaS2VVYzRNMjVSU21aTFJWQkNSV0pmZVVkcU5HZ3lPR05IVlhNeVEzQjFRbWhvTURsM1pVWjNORWhCTFdwT01GOXpYMEpzUkdNd1NHcFVMVmRXYmkwdFpUWk1Nbmx5VUhOWmNGWmhabk40Y2tkS1FURmljRzFuVHpGM01sVnhkMHhJTUZSbWNVNWxUVVkzVXpKRlYxaEVVWG94UWxOM1QyeHpkelUxWm1wbmNpMTVWMjlHUlV3eGVXcG1aaTFvWDJjeVZHbDFORWcyTW5oaVVTNU5VRFU1ZGpJMU1sQnZhbEZXU1RZMVZYUXpXa1JSLnJzSm1QX29kcU1pLWRCY0s5YWNUckN2VlR6ZXJ4b3kxbjlDWlRhTmlaeG8iLCJleHAiOjE3MjkxOTEzNTYsImlhdCI6MTcyOTEwNDk1Nn0.OmSXiw1A26w01Q98tADCECA5vIGNvBDk1hCVPzwIDQU", "callbacks": [{"type": "TextOutputCallback", "output": [{"name": "message", "value": "Loading..."}, {"name": "messageType", "value": "0"}]}, {"type": "ConfirmationCallback", "output": [{"name": "prompt", "value": ""}, {"name": "messageType", "value": 0}, {"name": "options", "value": ["Set up"]}, {"name": "optionType", "value": -1}, {"name": "defaultOption", "value": 0}], "input": [{"name": "IDToken2", "value": 0}]}, {"type": "HiddenValueCallback", "output": [{"name": "value", "value": "false"}, {"name": "id", "value": "skip-input-563"}], "input": [{"name": "IDToken3", "value": "Skip"}]}, {"type": "TextOutputCallback", "output": [{"name": "message", "value": "var setupPage = function() { var skipInputElem = document.getElementById(\"skip-input-563\"); var messageElem; document.getElementsByClassName(\"callback-component\").forEach( function (e) { var m = e.firstElementChild; if (m.firstChild && m.firstChild.nodeName == \"#text\" && m.firstChild.nodeValue.trim() == \"Loading...\") { messageElem = m; } } ); if (!skipInputElem || !messageElem) { return setTimeout(setupPage, 50); } var skipContainer = document.createElement(\"div\"); skipContainer.style = \"width:100%\"; skipContainer.innerHTML = \"\"; skipInputElem.parentNode.append(skipContainer); messageElem.align = \"center\"; messageElem.innerHTML = \"

Set up 2-step verification

To protect your account, add a second
authentication method.
Starting April 2, 2024, you must sign in using
2-step verification. Learn more here.
\"; var bindSkipLink = function() { document.getElementById(\"skip-link-563\").onclick = function() { skipInputElem.value = \"Skip\"; document.getElementById(\"loginButton_0\").click(); return false; }; }; setTimeout(bindSkipLink, 100);};setupPage();"}, {"name": "messageType", "value": "4"}]}]}' "https://openam-perf-benchmark.forgeblocks.com/am/json/authenticate?realm=/" 2024-10-16 18:55:57,066 INFO [http_cmd]: http status code OK 2024-10-16 18:55:57,066 DEBUG --- status code --- 2024-10-16 18:55:57,066 DEBUG http status code is 200 (expected 200) 2024-10-16 18:55:57,066 DEBUG --- http response --- 2024-10-16 18:55:57,066 DEBUG { "tokenId": "BIE1RydfGNuwGOjjto27y4uYjMk.*AAJTSQACMDIAAlNLABxPamdyKzFGaWFOSGZKRVRFak41M1dtc2krSVU9AAR0eXBlAANDVFMAAlMxAAIwMQ..*", "successUrl": "/platform", "realm": "/" } 2024-10-16 18:55:57,066 INFO [LoginSession] Obtaining session info 2024-10-16 18:55:57,067 INFO [http_cmd]: curl --insecure -L --request POST "https://openam-perf-benchmark.forgeblocks.com/am/json/sessions?_action=getSessionInfo" 2024-10-16 18:55:57,131 INFO [http_cmd]: http status code OK 2024-10-16 18:55:57,131 DEBUG --- status code --- 2024-10-16 18:55:57,131 DEBUG http status code is 200 (expected 200) 2024-10-16 18:55:57,131 DEBUG --- http response --- 2024-10-16 18:55:57,131 DEBUG { "username": "60de29b6-5497-45f5-afd8-167ef49a0efe", "universalId": "id=60de29b6-5497-45f5-afd8-167ef49a0efe,ou=user,ou=am-config", "realm": "/", "latestAccessTime": "2024-10-16T18:55:57Z", "maxIdleExpirationTime": "2024-10-16T19:25:57Z", "maxSessionExpirationTime": "2024-10-16T20:55:56Z", "properties": { "AMCtxId": "f00ef5c4-0efd-4df5-be5b-e7e82c5f43f0-18256496" } } 2024-10-16 18:55:57,132 INFO Obtain Oauth2 authz code via REST with PKCE flow 2024-10-16 18:55:57,132 DEBUG Oauth2 authorize for access token 2024-10-16 18:55:57,133 INFO [http_cmd]: curl --insecure --request POST --cookie "9b75a55744995d0=BIE1RydfGNuwGOjjto27y4uYjMk.*AAJTSQACMDIAAlNLABxPamdyKzFGaWFOSGZKRVRFak41M1dtc2krSVU9AAR0eXBlAANDVFMAAlMxAAIwMQ..*" --cookie "amlbcookie=01" --data '{"decision": "Allow", "csrf": "BIE1RydfGNuwGOjjto27y4uYjMk.*AAJTSQACMDIAAlNLABxPamdyKzFGaWFOSGZKRVRFak41M1dtc2krSVU9AAR0eXBlAANDVFMAAlMxAAIwMQ..*"}' "https://openam-perf-benchmark.forgeblocks.com/am/oauth2/authorize?client_id=idmAdminClient&scope=openid fr:idm:*&redirect_uri=https://openam-perf-benchmark.forgeblocks.com/platform/appAuthHelperRedirect.html&response_type=code&realm=/&code_challenge=H8VHP73pYVOJ0f7Y9lG3J5DU3gjTBCElj1L3LM6FgO&code_challenge_method=plain" 2024-10-16 18:55:57,215 INFO [http_cmd]: http status code OK 2024-10-16 18:55:57,215 DEBUG --- status code --- 2024-10-16 18:55:57,215 DEBUG http status code is 302 (expected 302) 2024-10-16 18:55:57,215 DEBUG --- http response --- 2024-10-16 18:55:57,215 DEBUG {'x-frame-options': 'SAMEORIGIN', 'content-security-policy-report-only': "frame-ancestors 'self'; script-src 'self' 'unsafe-eval' 'unsafe-inline'", 'x-content-type-options': 'nosniff', 'cache-control': 'no-store', 'location': 'https://openam-perf-benchmark.forgeblocks.com/platform/appAuthHelperRedirect.html?code=If0QgRxbM5g9dwTaZvYFDR7Eadw&iss=https%3A%2F%2Fopenam-perf-benchmark.forgeblocks.com%3A443%2Fam%2Foauth2&client_id=idmAdminClient', 'pragma': 'no-cache', 'set-cookie': 'OAUTH_REQUEST_ATTRIBUTES=DELETED; Expires=Thu, 01 Jan 1970 00:00:00 GMT; Path=/; Domain=openam-perf-benchmark.forgeblocks.com; Secure; HttpOnly; SameSite=none', 'Content-Length': '0', 'date': 'Wed, 16 Oct 2024 18:55:57 GMT', 'x-forgerock-transactionid': 'e460d1a8-f675-43f9-bf93-ac3768c4cb84', 'strict-transport-security': 'max-age=31536000; includeSubDomains; preload;', 'x-robots-tag': 'none', 'Via': '1.1 google', 'Alt-Svc': 'h3=":443"; ma=2592000,h3-29=":443"; ma=2592000'} 2024-10-16 18:55:57,215 DEBUG Oauth2 exchange authorize code for access token 2024-10-16 18:55:57,215 INFO [http_cmd]: curl --insecure -L --request POST --data '{"grant_type": "authorization_code", "redirect_uri": "https://openam-perf-benchmark.forgeblocks.com/platform/appAuthHelperRedirect.html", "client_id": "idmAdminClient", "code": "If0QgRxbM5g9dwTaZvYFDR7Eadw", "code_verifier": "H8VHP73pYVOJ0f7Y9lG3J5DU3gjTBCElj1L3LM6FgO"}' "https://openam-perf-benchmark.forgeblocks.com/am/oauth2/access_token?realm=/" 2024-10-16 18:55:57,281 INFO [http_cmd]: http status code OK 2024-10-16 18:55:57,281 DEBUG --- status code --- 2024-10-16 18:55:57,281 DEBUG http status code is 200 (expected 200) 2024-10-16 18:55:57,281 DEBUG --- http response --- 2024-10-16 18:55:57,281 DEBUG { "access_token": "eyJ0eXAiOiJKV1QiLCJraWQiOiIydHIwZkZTc3l5SS81Sm9mR0lWL1Z3MVJJSEk9IiwiYWxnIjoiUlMyNTYifQ.eyJzdWIiOiI2MGRlMjliNi01NDk3LTQ1ZjUtYWZkOC0xNjdlZjQ5YTBlZmUiLCJjdHMiOiJPQVVUSDJfU1RBVEVMRVNTX0dSQU5UIiwiYXV0aF9sZXZlbCI6MCwiYXVkaXRUcmFja2luZ0lkIjoiMjc1MDQ0MDAtMmY0Ni00ZTJjLWI2MmYtYmFjMTg1NTJlMmE2LTE4NDY4NTg5Iiwic3VibmFtZSI6IjYwZGUyOWI2LTU0OTctNDVmNS1hZmQ4LTE2N2VmNDlhMGVmZSIsImlzcyI6Imh0dHBzOi8vb3BlbmFtLXBlcmYtYmVuY2htYXJrLmZvcmdlYmxvY2tzLmNvbTo0NDMvYW0vb2F1dGgyIiwidG9rZW5OYW1lIjoiYWNjZXNzX3Rva2VuIiwidG9rZW5fdHlwZSI6IkJlYXJlciIsImF1dGhHcmFudElkIjoidi1DakF1bDhiZFJpS2tjWXRFcGVnVVE5anlJIiwiY2xpZW50X2lkIjoiaWRtQWRtaW5DbGllbnQiLCJhdWQiOiJpZG1BZG1pbkNsaWVudCIsIm5iZiI6MTcyOTEwNDk1NywiZ3JhbnRfdHlwZSI6ImF1dGhvcml6YXRpb25fY29kZSIsInNjb3BlIjpbImZyOmlkbToqIiwib3BlbmlkIl0sImF1dGhfdGltZSI6MTcyOTEwNDk1NywicmVhbG0iOiIvIiwiZXhwIjoxNzI5MTA4NTU3LCJpYXQiOjE3MjkxMDQ5NTcsImV4cGlyZXNfaW4iOjM2MDAsImp0aSI6ImtxWnA3LVpFX0xvM21md19DM3dnNXBqNTlzOCJ9.FpidH7EO_3lIDuH4qDonAIe-8Vud05jkxSwTLnztYgwViCc6J6CwwyctGQaFUy0P5ON3xjRp8hxCyYJPHVAFfG8MSKhSsBUgtLdzGfJzUW-MfAHlsgOpe2WeifN1y316qh_QMLqkaR-EE6WOmVmf1-JZUvRd4WD-hZvomhIeTLZrxrHD-HT9Uf9GQTwyKF7cGHwTZ73sL9zti2_GF1nSIfpMQb0CnUrTm_xJ7aGRUb8I4gUMrT_5gMTzvF_5fIK86YcRcuIEsqoUMYiVQ1FHSmFELXPvmS4skQtIA78RDXrEU6NmuJoOwfA4NrBPWLVRja_9QfVB9DiC77EdXRXmBw", "scope": "openid fr:idm:*", "id_token": "eyJ0eXAiOiJKV1QiLCJraWQiOiIydHIwZkZTc3l5SS81Sm9mR0lWL1Z3MVJJSEk9IiwiYWxnIjoiUlMyNTYifQ.eyJhdF9oYXNoIjoiWmFtbndtS096QTY3X2tKaUFXSExSUSIsInN1YiI6IjYwZGUyOWI2LTU0OTctNDVmNS1hZmQ4LTE2N2VmNDlhMGVmZSIsImF1ZGl0VHJhY2tpbmdJZCI6IjI3NTA0NDAwLTJmNDYtNGUyYy1iNjJmLWJhYzE4NTUyZTJhNi0xODQ2ODU5MCIsInN1Ym5hbWUiOiI2MGRlMjliNi01NDk3LTQ1ZjUtYWZkOC0xNjdlZjQ5YTBlZmUiLCJpc3MiOiJodHRwczovL29wZW5hbS1wZXJmLWJlbmNobWFyay5mb3JnZWJsb2Nrcy5jb206NDQzL2FtL29hdXRoMiIsInRva2VuTmFtZSI6ImlkX3Rva2VuIiwic2lkIjoiT0FvMkVBenpvam1vRVhmbXovb0xzSzFST1RvaEZybFZKM1IvckxjRCtoND0iLCJhdWQiOiJpZG1BZG1pbkNsaWVudCIsImNfaGFzaCI6IlBFOXdQX3VzTmdENUtRX0NyQlpzY2ciLCJhY3IiOiIwIiwib3JnLmZvcmdlcm9jay5vcGVuaWRjb25uZWN0Lm9wcyI6InhlX014Yy10eEdxQXdmWUNGOU44OWdXSkNiZyIsImF6cCI6ImlkbUFkbWluQ2xpZW50IiwiYXV0aF90aW1lIjoxNzI5MTA0OTU3LCJyZWFsbSI6Ii8iLCJleHAiOjE3MjkxMDg1NTcsInRva2VuVHlwZSI6IkpXVFRva2VuIiwiaWF0IjoxNzI5MTA0OTU3fQ.JvSMOvJhGtqUU3p_ADxxqrSlSwqzO4igpxtPG5t9OI3F3I4ymSsB3fJ2NELiWYO0-BxaczQ3M3BjvldL4NUj4y2IG4OrwpKssBrF079J49gBEK-8gFOGhaallfGKyf8qEpxjXFtPvuLcdqGrWKzSV5BZBRK9F7JWj78D-5bA2L9Butv_R4NbtsZqC1Uv-_DeCDJEdfWEUTvq4u-KleiDehj4izrb1D-SD4ObQohdegfh2gpNg3H5JI2xgx2dzkW8bB15Gi1TGmkhiK4y0Ss9s-OW1PDuNh8yrAtVVTcThoktfKiHfFB7oBgPYvVuQ8Ev62YexLTUKschQEScgyU23A", "token_type": "Bearer", "expires_in": 3599 } 2024-10-16 18:55:57,282 INFO Additional check to sync/queue to ensure sync with DS is ok (see LODESTAR-1245) 2024-10-16 18:55:57,282 INFO [http_cmd]: curl --insecure -L --request GET "https://openam-perf-benchmark.forgeblocks.com/openidm/sync/queue?_queryFilter=true&_pageSize=1" 2024-10-16 18:55:57,363 INFO [http_cmd]: http status code OK 2024-10-16 18:55:57,363 DEBUG --- status code --- 2024-10-16 18:55:57,363 DEBUG http status code is 200 (expected 200) 2024-10-16 18:55:57,363 DEBUG --- http response --- 2024-10-16 18:55:57,363 DEBUG { "result": [], "resultCount": 0, "pagedResultsCookie": null, "totalPagedResultsPolicy": "NONE", "totalPagedResults": -1, "remainingPagedResults": -1 } 2024-10-16 18:55:57,364 INFO Try to create, query and delete a user 2024-10-16 18:55:57,364 INFO Create user idm_aic8vfhkmq in IDM 2024-10-16 18:55:57,364 INFO [http_cmd]: curl --header "Authorization: Bearer eyJ0eXAiOiJKV1QiLCJraWQiOiIydHIwZkZTc3l5SS81Sm9mR0lWL1Z3MVJJSEk9IiwiYWxnIjoiUlMyNTYifQ.eyJzdWIiOiI2MGRlMjliNi01NDk3LTQ1ZjUtYWZkOC0xNjdlZjQ5YTBlZmUiLCJjdHMiOiJPQVVUSDJfU1RBVEVMRVNTX0dSQU5UIiwiYXV0aF9sZXZlbCI6MCwiYXVkaXRUcmFja2luZ0lkIjoiMjc1MDQ0MDAtMmY0Ni00ZTJjLWI2MmYtYmFjMTg1NTJlMmE2LTE4NDY4NTg5Iiwic3VibmFtZSI6IjYwZGUyOWI2LTU0OTctNDVmNS1hZmQ4LTE2N2VmNDlhMGVmZSIsImlzcyI6Imh0dHBzOi8vb3BlbmFtLXBlcmYtYmVuY2htYXJrLmZvcmdlYmxvY2tzLmNvbTo0NDMvYW0vb2F1dGgyIiwidG9rZW5OYW1lIjoiYWNjZXNzX3Rva2VuIiwidG9rZW5fdHlwZSI6IkJlYXJlciIsImF1dGhHcmFudElkIjoidi1DakF1bDhiZFJpS2tjWXRFcGVnVVE5anlJIiwiY2xpZW50X2lkIjoiaWRtQWRtaW5DbGllbnQiLCJhdWQiOiJpZG1BZG1pbkNsaWVudCIsIm5iZiI6MTcyOTEwNDk1NywiZ3JhbnRfdHlwZSI6ImF1dGhvcml6YXRpb25fY29kZSIsInNjb3BlIjpbImZyOmlkbToqIiwib3BlbmlkIl0sImF1dGhfdGltZSI6MTcyOTEwNDk1NywicmVhbG0iOiIvIiwiZXhwIjoxNzI5MTA4NTU3LCJpYXQiOjE3MjkxMDQ5NTcsImV4cGlyZXNfaW4iOjM2MDAsImp0aSI6ImtxWnA3LVpFX0xvM21md19DM3dnNXBqNTlzOCJ9.FpidH7EO_3lIDuH4qDonAIe-8Vud05jkxSwTLnztYgwViCc6J6CwwyctGQaFUy0P5ON3xjRp8hxCyYJPHVAFfG8MSKhSsBUgtLdzGfJzUW-MfAHlsgOpe2WeifN1y316qh_QMLqkaR-EE6WOmVmf1-JZUvRd4WD-hZvomhIeTLZrxrHD-HT9Uf9GQTwyKF7cGHwTZ73sL9zti2_GF1nSIfpMQb0CnUrTm_xJ7aGRUb8I4gUMrT_5gMTzvF_5fIK86YcRcuIEsqoUMYiVQ1FHSmFELXPvmS4skQtIA78RDXrEU6NmuJoOwfA4NrBPWLVRja_9QfVB9DiC77EdXRXmBw" --header "Content-Type: application/json" --insecure -L --request POST --data '{"userName": "idm_aic8vfhkmq", "givenName": "Peter", "sn": "Parker", "password": "T35!tr0c-k123", "telephoneNumber": "6669876987", "description": "IDM Test User", "roles": [], "mail": "idm_aic8vfhkmq@forgerock.com"}' "https://openam-perf-benchmark.forgeblocks.com/openidm/managed/alpha_user?_action=create" 2024-10-16 18:55:57,498 INFO [http_cmd]: http status code OK 2024-10-16 18:55:57,498 DEBUG --- status code --- 2024-10-16 18:55:57,498 DEBUG http status code is 201 (expected [200, 201]) 2024-10-16 18:55:57,498 DEBUG --- http response --- 2024-10-16 18:55:57,498 DEBUG [print_head_tail]: Print head (10 lines) and tail (10 lines) of input string (69 lines): 2024-10-16 18:55:57,498 DEBUG ----- output ----- 2024-10-16 18:55:57,498 DEBUG { 2024-10-16 18:55:57,498 DEBUG "_id": "a7e87a46-e0bc-48bb-8f87-672ce45278ed", 2024-10-16 18:55:57,498 DEBUG "_rev": "6cd2f146-017e-49af-a442-a00efd4b5e9e-3782833", 2024-10-16 18:55:57,498 DEBUG "country": null, 2024-10-16 18:55:57,498 DEBUG "frUnindexedString1": null, 2024-10-16 18:55:57,498 DEBUG "mail": "idm_aic8vfhkmq@forgerock.com", 2024-10-16 18:55:57,498 DEBUG "memberOfOrgIDs": [], 2024-10-16 18:55:57,498 DEBUG "frIndexedDate5": null, 2024-10-16 18:55:57,498 DEBUG "frUnindexedString2": null, 2024-10-16 18:55:57,498 DEBUG "frIndexedDate4": null, 2024-10-16 18:55:57,498 DEBUG 2024-10-16 18:55:57,498 DEBUG 2024-10-16 18:55:57,498 DEBUG 2024-10-16 18:55:57,498 DEBUG [...] 2024-10-16 18:55:57,499 DEBUG 2024-10-16 18:55:57,499 DEBUG 2024-10-16 18:55:57,499 DEBUG 2024-10-16 18:55:57,499 DEBUG "sn": "Parker", 2024-10-16 18:55:57,499 DEBUG "frUnindexedDate1": null, 2024-10-16 18:55:57,499 DEBUG "frIndexedInteger5": null, 2024-10-16 18:55:57,499 DEBUG "preferences": null, 2024-10-16 18:55:57,499 DEBUG "userName": "idm_aic8vfhkmq", 2024-10-16 18:55:57,499 DEBUG "frIndexedDate2": null, 2024-10-16 18:55:57,499 DEBUG "passwordLastChangedTime": "2024-10-16T18:55:57.266Z", 2024-10-16 18:55:57,499 DEBUG "frIndexedDate1": null, 2024-10-16 18:55:57,499 DEBUG "effectiveRoles": [] 2024-10-16 18:55:57,499 DEBUG } 2024-10-16 18:55:57,499 INFO Query IDM to verify UserID a7e87a46-e0bc-48bb-8f87-672ce45278ed is visible 2024-10-16 18:55:57,499 INFO [http_cmd]: curl --insecure -L --request GET "https://openam-perf-benchmark.forgeblocks.com/openidm/managed/alpha_user/a7e87a46-e0bc-48bb-8f87-672ce45278ed" 2024-10-16 18:55:57,564 INFO [http_cmd]: http status code OK 2024-10-16 18:55:57,564 DEBUG --- status code --- 2024-10-16 18:55:57,564 DEBUG http status code is 200 (expected 200) 2024-10-16 18:55:57,565 DEBUG --- http response --- 2024-10-16 18:55:57,565 DEBUG [print_head_tail]: Print head (10 lines) and tail (10 lines) of input string (69 lines): 2024-10-16 18:55:57,565 DEBUG ----- output ----- 2024-10-16 18:55:57,565 DEBUG { 2024-10-16 18:55:57,565 DEBUG "_id": "a7e87a46-e0bc-48bb-8f87-672ce45278ed", 2024-10-16 18:55:57,565 DEBUG "_rev": "6cd2f146-017e-49af-a442-a00efd4b5e9e-3782833", 2024-10-16 18:55:57,565 DEBUG "country": null, 2024-10-16 18:55:57,565 DEBUG "frUnindexedString1": null, 2024-10-16 18:55:57,565 DEBUG "mail": "idm_aic8vfhkmq@forgerock.com", 2024-10-16 18:55:57,565 DEBUG "memberOfOrgIDs": [], 2024-10-16 18:55:57,565 DEBUG "frIndexedDate5": null, 2024-10-16 18:55:57,565 DEBUG "frUnindexedString2": null, 2024-10-16 18:55:57,565 DEBUG "frIndexedDate4": null, 2024-10-16 18:55:57,565 DEBUG 2024-10-16 18:55:57,565 DEBUG 2024-10-16 18:55:57,565 DEBUG 2024-10-16 18:55:57,565 DEBUG [...] 2024-10-16 18:55:57,565 DEBUG 2024-10-16 18:55:57,565 DEBUG 2024-10-16 18:55:57,565 DEBUG 2024-10-16 18:55:57,565 DEBUG "sn": "Parker", 2024-10-16 18:55:57,565 DEBUG "frUnindexedDate1": null, 2024-10-16 18:55:57,565 DEBUG "frIndexedInteger5": null, 2024-10-16 18:55:57,565 DEBUG "preferences": null, 2024-10-16 18:55:57,565 DEBUG "userName": "idm_aic8vfhkmq", 2024-10-16 18:55:57,565 DEBUG "frIndexedDate2": null, 2024-10-16 18:55:57,565 DEBUG "passwordLastChangedTime": "2024-10-16T18:55:57.266Z", 2024-10-16 18:55:57,565 DEBUG "frIndexedDate1": null, 2024-10-16 18:55:57,565 DEBUG "effectiveRoles": [] 2024-10-16 18:55:57,565 DEBUG } 2024-10-16 18:55:57,565 INFO Authenticate as user idm_aic8vfhkmq 2024-10-16 18:55:57,566 INFO [http_cmd]: curl --insecure -L --request POST "https://openam-perf-benchmark.forgeblocks.com/openidm/authentication?_action=login" 2024-10-16 18:55:57,625 INFO [http_cmd]: http status code OK 2024-10-16 18:55:57,625 DEBUG --- status code --- 2024-10-16 18:55:57,625 DEBUG http status code is 200 (expected 200) 2024-10-16 18:55:57,626 DEBUG --- http response --- 2024-10-16 18:55:57,626 DEBUG { "_id": "login", "authorization": { "id": "anonymous", "roles": [ "internal/role/openidm-reg" ], "component": "internal/user" }, "authenticationId": "anonymous" } 2024-10-16 18:55:57,626 INFO [http_cmd]: curl --insecure -L --request DELETE "https://openam-perf-benchmark.forgeblocks.com/openidm/managed/alpha_user/a7e87a46-e0bc-48bb-8f87-672ce45278ed" 2024-10-16 18:55:57,708 INFO [http_cmd]: http status code OK 2024-10-16 18:55:57,708 DEBUG --- status code --- 2024-10-16 18:55:57,708 DEBUG http status code is 200 (expected 200) 2024-10-16 18:55:57,708 DEBUG --- http response --- 2024-10-16 18:55:57,708 DEBUG [print_head_tail]: Print head (10 lines) and tail (10 lines) of input string (69 lines): 2024-10-16 18:55:57,708 DEBUG ----- output ----- 2024-10-16 18:55:57,708 DEBUG { 2024-10-16 18:55:57,708 DEBUG "_id": "a7e87a46-e0bc-48bb-8f87-672ce45278ed", 2024-10-16 18:55:57,708 DEBUG "_rev": "6cd2f146-017e-49af-a442-a00efd4b5e9e-3782833", 2024-10-16 18:55:57,708 DEBUG "country": null, 2024-10-16 18:55:57,708 DEBUG "frUnindexedString1": null, 2024-10-16 18:55:57,708 DEBUG "mail": "idm_aic8vfhkmq@forgerock.com", 2024-10-16 18:55:57,708 DEBUG "memberOfOrgIDs": [], 2024-10-16 18:55:57,708 DEBUG "frIndexedDate5": null, 2024-10-16 18:55:57,708 DEBUG "frUnindexedString2": null, 2024-10-16 18:55:57,708 DEBUG "frIndexedDate4": null, 2024-10-16 18:55:57,708 DEBUG 2024-10-16 18:55:57,708 DEBUG 2024-10-16 18:55:57,708 DEBUG 2024-10-16 18:55:57,708 DEBUG [...] 2024-10-16 18:55:57,708 DEBUG 2024-10-16 18:55:57,709 DEBUG 2024-10-16 18:55:57,709 DEBUG 2024-10-16 18:55:57,709 DEBUG "sn": "Parker", 2024-10-16 18:55:57,709 DEBUG "frUnindexedDate1": null, 2024-10-16 18:55:57,709 DEBUG "frIndexedInteger5": null, 2024-10-16 18:55:57,709 DEBUG "preferences": null, 2024-10-16 18:55:57,709 DEBUG "userName": "idm_aic8vfhkmq", 2024-10-16 18:55:57,709 DEBUG "frIndexedDate2": null, 2024-10-16 18:55:57,709 DEBUG "passwordLastChangedTime": "2024-10-16T18:55:57.266Z", 2024-10-16 18:55:57,709 DEBUG "frIndexedDate1": null, 2024-10-16 18:55:57,709 DEBUG "effectiveRoles": [] 2024-10-16 18:55:57,709 DEBUG } 2024-10-16 18:55:57,709 INFO 2024-10-16 18:55:57,709 INFO --------------------- Running CTSSTORE livecheck --------------------- 2024-10-16 18:55:57,709 INFO 2024-10-16 18:55:57,709 INFO --------------------- Running USERSTORE livecheck --------------------- 2024-10-16 18:55:57,709 INFO 2024-10-16 18:55:57,709 INFO -------------------- Running PLATFORM-UI livecheck -------------------- 2024-10-16 18:55:57,709 INFO Livecheck to https://openam-perf-benchmark.forgeblocks.com/am/XUI 2024-10-16 18:55:57,710 INFO [http_cmd]: curl --insecure -L --request GET "https://openam-perf-benchmark.forgeblocks.com/am/XUI" 2024-10-16 18:55:57,814 INFO [http_cmd]: http status code OK 2024-10-16 18:55:57,814 DEBUG --- status code --- 2024-10-16 18:55:57,814 DEBUG http status code is 200 (expected 200) 2024-10-16 18:55:57,814 DEBUG --- http response --- 2024-10-16 18:55:57,815 DEBUG Login
[] 2024-10-16 18:55:57,815 INFO LIVECHECK SUCCEEDED 2024-10-16 18:55:57,815 INFO 2024-10-16 18:55:57,815 INFO ****************************** Initializing component pods for AM ****************************** 2024-10-16 18:55:57,815 INFO 2024-10-16 18:55:57,815 INFO ----------------------- Get AM software version ----------------------- 2024-10-16 18:55:57,815 INFO Getting product version from https://openam-perf-benchmark.forgeblocks.com/am/json/realms/alpha/serverinfo/version 2024-10-16 18:55:57,815 INFO [LoginSession] Get "token_id" token for user "xiaosong.lou@pingidentity.com" 2024-10-16 18:55:57,815 DEBUG [LoginSession] re-using "token_id" token that remains valid for 29m 49s 2024-10-16 18:55:57,816 INFO [http_cmd]: curl --insecure -L --request GET --cookie "9b75a55744995d0=BIE1RydfGNuwGOjjto27y4uYjMk.*AAJTSQACMDIAAlNLABxPamdyKzFGaWFOSGZKRVRFak41M1dtc2krSVU9AAR0eXBlAANDVFMAAlMxAAIwMQ..*" --cookie "amlbcookie=01" "https://openam-perf-benchmark.forgeblocks.com/am/json/realms/alpha/serverinfo/version" 2024-10-16 18:55:57,890 INFO [http_cmd]: http status code OK 2024-10-16 18:55:57,890 DEBUG --- status code --- 2024-10-16 18:55:57,890 DEBUG http status code is 200 (expected 200) 2024-10-16 18:55:57,890 DEBUG --- http response --- 2024-10-16 18:55:57,890 DEBUG { "_id": "version", "_rev": "655405166", "version": "7.6.0-SNAPSHOT", "fullVersion": "ForgeRock Access Management 7.6.0-SNAPSHOT Build 7f4ea476ca0afb4f4ff6ae80b66d8c258ec64ba3 (2024-October-09 14:42)", "revision": "7f4ea476ca0afb4f4ff6ae80b66d8c258ec64ba3", "date": "2024-October-09 14:42" } 2024-10-16 18:55:57,891 INFO 2024-10-16 18:55:57,891 INFO ***************************** Initializing component pods for IDM ***************************** 2024-10-16 18:55:57,891 INFO 2024-10-16 18:55:57,891 INFO ---------------------- Get IDM software version ---------------------- 2024-10-16 18:55:57,891 INFO Getting product version from https://openam-perf-benchmark.forgeblocks.com/openidm/info/version 2024-10-16 18:55:57,891 INFO [http_cmd]: curl --insecure -L --request GET "https://openam-perf-benchmark.forgeblocks.com/openidm/info/version" 2024-10-16 18:55:57,944 INFO [http_cmd]: http status code OK 2024-10-16 18:55:57,944 DEBUG --- status code --- 2024-10-16 18:55:57,944 DEBUG http status code is 200 (expected 200) 2024-10-16 18:55:57,944 DEBUG --- http response --- 2024-10-16 18:55:57,944 DEBUG { "_id": "version", "productVersion": "7.6.0-2024-8-0-SNAPSHOT", "productBuildDate": "20240911083624", "productRevision": "6bff894932" } 2024-10-16 18:55:57,944 INFO 2024-10-16 18:55:57,944 INFO *************************** Initializing component pods for CTSSTORE *************************** 2024-10-16 18:55:57,944 INFO 2024-10-16 18:55:57,944 INFO -------------------- Get CTSSTORE software version -------------------- 2024-10-16 18:55:57,944 WARNING Component ctsstore is not in Running state so impossible to get software version 2024-10-16 18:55:57,945 INFO 2024-10-16 18:55:57,945 INFO ************************** Initializing component pods for USERSTORE ************************** 2024-10-16 18:55:57,945 INFO 2024-10-16 18:55:57,945 INFO ------------------- Get USERSTORE software version ------------------- 2024-10-16 18:55:57,945 WARNING Component userstore is not in Running state so impossible to get software version 2024-10-16 18:55:57,945 INFO 2024-10-16 18:55:57,945 INFO ************************* Initializing component pods for PLATFORM-UI ************************* 2024-10-16 18:55:57,945 INFO 2024-10-16 18:55:57,945 INFO ------------------ Get PLATFORM-UI software version ------------------ 2024-10-16 18:55:57,945 WARNING Component platform-ui is not in Running state so impossible to get software version 2024-10-16 18:55:57,945 INFO 2024-10-16 18:55:57,945 INFO ***************** Validate revisions of product images deployed on the tenant ***************** 2024-10-16 18:55:58,512 INFO No components images provided in configuration, skipping revision validation 2024-10-16 18:55:58,512 WARNING No access to the tenant project, end of discovery 2024-10-16 18:55:59,013 INFO 2024-10-16 18:55:59,013 INFO ********************* Livecheck stage: After environment variables update ********************* 2024-10-16 18:55:59,013 INFO 2024-10-16 18:55:59,013 INFO ------------------------ Running AM livecheck ------------------------ 2024-10-16 18:55:59,013 INFO Livecheck to https://openam-perf-benchmark.forgeblocks.com/am/json/health/ready 2024-10-16 18:55:59,013 INFO [http_cmd]: curl --insecure -L --request GET "https://openam-perf-benchmark.forgeblocks.com/am/json/health/ready" 2024-10-16 18:55:59,063 INFO [http_cmd]: http status code OK 2024-10-16 18:55:59,063 DEBUG --- status code --- 2024-10-16 18:55:59,063 DEBUG http status code is 200 (expected 200) 2024-10-16 18:55:59,063 DEBUG --- http response --- 2024-10-16 18:55:59,064 DEBUG 2024-10-16 18:55:59,064 INFO 2024-10-16 18:55:59,064 INFO ------------------------ Running IDM livecheck ------------------------ 2024-10-16 18:55:59,064 INFO Livecheck to https://openam-perf-benchmark.forgeblocks.com/openidm/info/ping 2024-10-16 18:55:59,064 INFO [http_cmd]: curl --insecure -L --request GET "https://openam-perf-benchmark.forgeblocks.com/openidm/info/ping" 2024-10-16 18:55:59,117 INFO [http_cmd]: http status code OK 2024-10-16 18:55:59,117 DEBUG --- status code --- 2024-10-16 18:55:59,117 DEBUG http status code is 200 (expected 200) 2024-10-16 18:55:59,117 DEBUG --- http response --- 2024-10-16 18:55:59,117 DEBUG { "_id": "", "_rev": "", "shortDesc": "OpenIDM ready", "state": "ACTIVE_READY" } 2024-10-16 18:55:59,117 INFO [LoginSession] Get "access_token" token for user "xiaosong.lou@pingidentity.com" 2024-10-16 18:55:59,117 DEBUG [LoginSession] re-using "access_token" token that remains valid for 59m 48s 2024-10-16 18:55:59,117 INFO Additional check to sync/queue to ensure sync with DS is ok (see LODESTAR-1245) 2024-10-16 18:55:59,117 INFO [http_cmd]: curl --insecure -L --request GET "https://openam-perf-benchmark.forgeblocks.com/openidm/sync/queue?_queryFilter=true&_pageSize=1" 2024-10-16 18:55:59,188 INFO [http_cmd]: http status code OK 2024-10-16 18:55:59,189 DEBUG --- status code --- 2024-10-16 18:55:59,189 DEBUG http status code is 200 (expected 200) 2024-10-16 18:55:59,189 DEBUG --- http response --- 2024-10-16 18:55:59,189 DEBUG { "result": [], "resultCount": 0, "pagedResultsCookie": null, "totalPagedResultsPolicy": "NONE", "totalPagedResults": -1, "remainingPagedResults": -1 } 2024-10-16 18:55:59,189 INFO Try to create, query and delete a user 2024-10-16 18:55:59,189 INFO Create user idm_mbizmt8i59 in IDM 2024-10-16 18:55:59,189 INFO [http_cmd]: curl --header "Authorization: Bearer eyJ0eXAiOiJKV1QiLCJraWQiOiIydHIwZkZTc3l5SS81Sm9mR0lWL1Z3MVJJSEk9IiwiYWxnIjoiUlMyNTYifQ.eyJzdWIiOiI2MGRlMjliNi01NDk3LTQ1ZjUtYWZkOC0xNjdlZjQ5YTBlZmUiLCJjdHMiOiJPQVVUSDJfU1RBVEVMRVNTX0dSQU5UIiwiYXV0aF9sZXZlbCI6MCwiYXVkaXRUcmFja2luZ0lkIjoiMjc1MDQ0MDAtMmY0Ni00ZTJjLWI2MmYtYmFjMTg1NTJlMmE2LTE4NDY4NTg5Iiwic3VibmFtZSI6IjYwZGUyOWI2LTU0OTctNDVmNS1hZmQ4LTE2N2VmNDlhMGVmZSIsImlzcyI6Imh0dHBzOi8vb3BlbmFtLXBlcmYtYmVuY2htYXJrLmZvcmdlYmxvY2tzLmNvbTo0NDMvYW0vb2F1dGgyIiwidG9rZW5OYW1lIjoiYWNjZXNzX3Rva2VuIiwidG9rZW5fdHlwZSI6IkJlYXJlciIsImF1dGhHcmFudElkIjoidi1DakF1bDhiZFJpS2tjWXRFcGVnVVE5anlJIiwiY2xpZW50X2lkIjoiaWRtQWRtaW5DbGllbnQiLCJhdWQiOiJpZG1BZG1pbkNsaWVudCIsIm5iZiI6MTcyOTEwNDk1NywiZ3JhbnRfdHlwZSI6ImF1dGhvcml6YXRpb25fY29kZSIsInNjb3BlIjpbImZyOmlkbToqIiwib3BlbmlkIl0sImF1dGhfdGltZSI6MTcyOTEwNDk1NywicmVhbG0iOiIvIiwiZXhwIjoxNzI5MTA4NTU3LCJpYXQiOjE3MjkxMDQ5NTcsImV4cGlyZXNfaW4iOjM2MDAsImp0aSI6ImtxWnA3LVpFX0xvM21md19DM3dnNXBqNTlzOCJ9.FpidH7EO_3lIDuH4qDonAIe-8Vud05jkxSwTLnztYgwViCc6J6CwwyctGQaFUy0P5ON3xjRp8hxCyYJPHVAFfG8MSKhSsBUgtLdzGfJzUW-MfAHlsgOpe2WeifN1y316qh_QMLqkaR-EE6WOmVmf1-JZUvRd4WD-hZvomhIeTLZrxrHD-HT9Uf9GQTwyKF7cGHwTZ73sL9zti2_GF1nSIfpMQb0CnUrTm_xJ7aGRUb8I4gUMrT_5gMTzvF_5fIK86YcRcuIEsqoUMYiVQ1FHSmFELXPvmS4skQtIA78RDXrEU6NmuJoOwfA4NrBPWLVRja_9QfVB9DiC77EdXRXmBw" --header "Content-Type: application/json" --insecure -L --request POST --data '{"userName": "idm_mbizmt8i59", "givenName": "Peter", "sn": "Parker", "password": "T35!tr0c-k123", "telephoneNumber": "6669876987", "description": "IDM Test User", "roles": [], "mail": "idm_mbizmt8i59@forgerock.com"}' "https://openam-perf-benchmark.forgeblocks.com/openidm/managed/alpha_user?_action=create" 2024-10-16 18:55:59,293 INFO [http_cmd]: http status code OK 2024-10-16 18:55:59,293 DEBUG --- status code --- 2024-10-16 18:55:59,293 DEBUG http status code is 201 (expected [200, 201]) 2024-10-16 18:55:59,293 DEBUG --- http response --- 2024-10-16 18:55:59,294 DEBUG [print_head_tail]: Print head (10 lines) and tail (10 lines) of input string (69 lines): 2024-10-16 18:55:59,294 DEBUG ----- output ----- 2024-10-16 18:55:59,294 DEBUG { 2024-10-16 18:55:59,294 DEBUG "_id": "111172a5-7c44-42c7-981d-76760c6d54a0", 2024-10-16 18:55:59,294 DEBUG "_rev": "6cd2f146-017e-49af-a442-a00efd4b5e9e-3782838", 2024-10-16 18:55:59,294 DEBUG "country": null, 2024-10-16 18:55:59,294 DEBUG "frUnindexedString1": null, 2024-10-16 18:55:59,294 DEBUG "mail": "idm_mbizmt8i59@forgerock.com", 2024-10-16 18:55:59,294 DEBUG "memberOfOrgIDs": [], 2024-10-16 18:55:59,294 DEBUG "frIndexedDate5": null, 2024-10-16 18:55:59,294 DEBUG "frUnindexedString2": null, 2024-10-16 18:55:59,294 DEBUG "frIndexedDate4": null, 2024-10-16 18:55:59,294 DEBUG 2024-10-16 18:55:59,294 DEBUG 2024-10-16 18:55:59,294 DEBUG 2024-10-16 18:55:59,294 DEBUG [...] 2024-10-16 18:55:59,294 DEBUG 2024-10-16 18:55:59,294 DEBUG 2024-10-16 18:55:59,294 DEBUG 2024-10-16 18:55:59,294 DEBUG "sn": "Parker", 2024-10-16 18:55:59,294 DEBUG "frUnindexedDate1": null, 2024-10-16 18:55:59,294 DEBUG "frIndexedInteger5": null, 2024-10-16 18:55:59,294 DEBUG "preferences": null, 2024-10-16 18:55:59,294 DEBUG "userName": "idm_mbizmt8i59", 2024-10-16 18:55:59,294 DEBUG "frIndexedDate2": null, 2024-10-16 18:55:59,294 DEBUG "passwordLastChangedTime": "2024-10-16T18:55:59.067Z", 2024-10-16 18:55:59,294 DEBUG "frIndexedDate1": null, 2024-10-16 18:55:59,294 DEBUG "effectiveRoles": [] 2024-10-16 18:55:59,294 DEBUG } 2024-10-16 18:55:59,295 INFO Query IDM to verify UserID 111172a5-7c44-42c7-981d-76760c6d54a0 is visible 2024-10-16 18:55:59,295 INFO [http_cmd]: curl --insecure -L --request GET "https://openam-perf-benchmark.forgeblocks.com/openidm/managed/alpha_user/111172a5-7c44-42c7-981d-76760c6d54a0" 2024-10-16 18:55:59,358 INFO [http_cmd]: http status code OK 2024-10-16 18:55:59,358 DEBUG --- status code --- 2024-10-16 18:55:59,358 DEBUG http status code is 200 (expected 200) 2024-10-16 18:55:59,358 DEBUG --- http response --- 2024-10-16 18:55:59,358 DEBUG [print_head_tail]: Print head (10 lines) and tail (10 lines) of input string (69 lines): 2024-10-16 18:55:59,358 DEBUG ----- output ----- 2024-10-16 18:55:59,358 DEBUG { 2024-10-16 18:55:59,358 DEBUG "_id": "111172a5-7c44-42c7-981d-76760c6d54a0", 2024-10-16 18:55:59,358 DEBUG "_rev": "6cd2f146-017e-49af-a442-a00efd4b5e9e-3782838", 2024-10-16 18:55:59,358 DEBUG "country": null, 2024-10-16 18:55:59,358 DEBUG "frUnindexedString1": null, 2024-10-16 18:55:59,358 DEBUG "mail": "idm_mbizmt8i59@forgerock.com", 2024-10-16 18:55:59,358 DEBUG "memberOfOrgIDs": [], 2024-10-16 18:55:59,358 DEBUG "frIndexedDate5": null, 2024-10-16 18:55:59,358 DEBUG "frUnindexedString2": null, 2024-10-16 18:55:59,358 DEBUG "frIndexedDate4": null, 2024-10-16 18:55:59,358 DEBUG 2024-10-16 18:55:59,358 DEBUG 2024-10-16 18:55:59,359 DEBUG 2024-10-16 18:55:59,359 DEBUG [...] 2024-10-16 18:55:59,359 DEBUG 2024-10-16 18:55:59,359 DEBUG 2024-10-16 18:55:59,359 DEBUG 2024-10-16 18:55:59,359 DEBUG "sn": "Parker", 2024-10-16 18:55:59,359 DEBUG "frUnindexedDate1": null, 2024-10-16 18:55:59,359 DEBUG "frIndexedInteger5": null, 2024-10-16 18:55:59,359 DEBUG "preferences": null, 2024-10-16 18:55:59,359 DEBUG "userName": "idm_mbizmt8i59", 2024-10-16 18:55:59,359 DEBUG "frIndexedDate2": null, 2024-10-16 18:55:59,359 DEBUG "passwordLastChangedTime": "2024-10-16T18:55:59.067Z", 2024-10-16 18:55:59,359 DEBUG "frIndexedDate1": null, 2024-10-16 18:55:59,359 DEBUG "effectiveRoles": [] 2024-10-16 18:55:59,359 DEBUG } 2024-10-16 18:55:59,359 INFO Authenticate as user idm_mbizmt8i59 2024-10-16 18:55:59,359 INFO [http_cmd]: curl --insecure -L --request POST "https://openam-perf-benchmark.forgeblocks.com/openidm/authentication?_action=login" 2024-10-16 18:55:59,412 INFO [http_cmd]: http status code OK 2024-10-16 18:55:59,412 DEBUG --- status code --- 2024-10-16 18:55:59,412 DEBUG http status code is 200 (expected 200) 2024-10-16 18:55:59,412 DEBUG --- http response --- 2024-10-16 18:55:59,412 DEBUG { "_id": "login", "authorization": { "id": "anonymous", "roles": [ "internal/role/openidm-reg" ], "component": "internal/user" }, "authenticationId": "anonymous" } 2024-10-16 18:55:59,413 INFO [http_cmd]: curl --insecure -L --request DELETE "https://openam-perf-benchmark.forgeblocks.com/openidm/managed/alpha_user/111172a5-7c44-42c7-981d-76760c6d54a0" 2024-10-16 18:55:59,495 INFO [http_cmd]: http status code OK 2024-10-16 18:55:59,495 DEBUG --- status code --- 2024-10-16 18:55:59,495 DEBUG http status code is 200 (expected 200) 2024-10-16 18:55:59,495 DEBUG --- http response --- 2024-10-16 18:55:59,495 DEBUG [print_head_tail]: Print head (10 lines) and tail (10 lines) of input string (69 lines): 2024-10-16 18:55:59,495 DEBUG ----- output ----- 2024-10-16 18:55:59,495 DEBUG { 2024-10-16 18:55:59,495 DEBUG "_id": "111172a5-7c44-42c7-981d-76760c6d54a0", 2024-10-16 18:55:59,495 DEBUG "_rev": "6cd2f146-017e-49af-a442-a00efd4b5e9e-3782838", 2024-10-16 18:55:59,495 DEBUG "country": null, 2024-10-16 18:55:59,496 DEBUG "frUnindexedString1": null, 2024-10-16 18:55:59,496 DEBUG "mail": "idm_mbizmt8i59@forgerock.com", 2024-10-16 18:55:59,496 DEBUG "memberOfOrgIDs": [], 2024-10-16 18:55:59,496 DEBUG "frIndexedDate5": null, 2024-10-16 18:55:59,496 DEBUG "frUnindexedString2": null, 2024-10-16 18:55:59,496 DEBUG "frIndexedDate4": null, 2024-10-16 18:55:59,496 DEBUG 2024-10-16 18:55:59,496 DEBUG 2024-10-16 18:55:59,496 DEBUG 2024-10-16 18:55:59,496 DEBUG [...] 2024-10-16 18:55:59,496 DEBUG 2024-10-16 18:55:59,496 DEBUG 2024-10-16 18:55:59,496 DEBUG 2024-10-16 18:55:59,496 DEBUG "sn": "Parker", 2024-10-16 18:55:59,496 DEBUG "frUnindexedDate1": null, 2024-10-16 18:55:59,496 DEBUG "frIndexedInteger5": null, 2024-10-16 18:55:59,496 DEBUG "preferences": null, 2024-10-16 18:55:59,496 DEBUG "userName": "idm_mbizmt8i59", 2024-10-16 18:55:59,496 DEBUG "frIndexedDate2": null, 2024-10-16 18:55:59,496 DEBUG "passwordLastChangedTime": "2024-10-16T18:55:59.067Z", 2024-10-16 18:55:59,496 DEBUG "frIndexedDate1": null, 2024-10-16 18:55:59,496 DEBUG "effectiveRoles": [] 2024-10-16 18:55:59,496 DEBUG } 2024-10-16 18:55:59,496 INFO 2024-10-16 18:55:59,496 INFO --------------------- Running CTSSTORE livecheck --------------------- 2024-10-16 18:55:59,496 INFO 2024-10-16 18:55:59,497 INFO --------------------- Running USERSTORE livecheck --------------------- 2024-10-16 18:55:59,497 INFO 2024-10-16 18:55:59,497 INFO -------------------- Running PLATFORM-UI livecheck -------------------- 2024-10-16 18:55:59,497 INFO Livecheck to https://openam-perf-benchmark.forgeblocks.com/am/XUI 2024-10-16 18:55:59,497 INFO [http_cmd]: curl --insecure -L --request GET "https://openam-perf-benchmark.forgeblocks.com/am/XUI" 2024-10-16 18:55:59,595 INFO [http_cmd]: http status code OK 2024-10-16 18:55:59,595 DEBUG --- status code --- 2024-10-16 18:55:59,595 DEBUG http status code is 200 (expected 200) 2024-10-16 18:55:59,595 DEBUG --- http response --- 2024-10-16 18:55:59,595 DEBUG Login
[] 2024-10-16 18:55:59,595 INFO LIVECHECK SUCCEEDED 2024-10-16 18:55:59 - INFO: Deployment successful ________________________________________________________________________________ [2024-10-16 18:55:59] Tenant_discovery_and_deployment post : Post method ________________________________________________________________________________ Setting result to PASS Task has been successfully stopped