is in ACTIVE state now
2025-07-31 13:54:13,638 - INFO - VM name : ctest-fvn_vm1_name-89671020
2025-07-31 13:54:13,711 - DEBUG - VM ctest-fvn_vm1_name-89671020 ID is 0666042d-2308-4e47-80b5-c74b30fb1952
2025-07-31 13:54:13,711 - DEBUG - VM ctest-fvn_vm1_name-89671020 launched on Node cn-jenkins-deploy-platform-ansible-os-3737-1
2025-07-31 13:54:13,779 - DEBUG - Requesting: http://10.0.0.65:8082/virtual-machine/0666042d-2308-4e47-80b5-c74b30fb1952
2025-07-31 13:54:13,788 - DEBUG - Requesting: http://10.0.0.65:8082/virtual-machine-interface/93dc5dc4-dd49-4811-a40c-91e413463882
2025-07-31 13:54:14,990 - DEBUG - (True, 'PING 169.254.0.4 (169.254.0.4) 56(84) bytes of data.\r\n64 bytes from 169.254.0.4: icmp_seq=1 ttl=63 time=3.11 ms\r\n64 bytes from 169.254.0.4: icmp_seq=2 ttl=63 time=0.355 ms\r\n\r\n--- 169.254.0.4 ping statistics ---\r\n2 packets transmitted, 2 received, 0% packet loss, time 1001ms\r\nrtt min/avg/max/mdev = 0.355/1.733/3.112/1.378 ms')
2025-07-31 13:54:14,990 - INFO - Ping to Metadata IP 169.254.0.4 of VM ctest-fvn_vm1_name-89671020 passed
2025-07-31 13:54:15,151 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2025-07-31 13:54:15,151 - DEBUG - Waiting to SSH to VM ctest-fvn_vm1_name-89671020, IP 107.145.123.3, Port 22
2025-07-31 13:54:15,220 - DEBUG - VM ctest-fvn_vm1_name-89671020 is ready for SSH connections
2025-07-31 13:54:15,355 - INFO - FIP 107.145.123.4 verification for passed on all Control-nodes
2025-07-31 13:54:15,355 - INFO - FIP ID 4b73cc8f-200c-4cd7-9bbf-34edec1e7518(107.145.123.4) validation in Control node passed
2025-07-31 13:54:15,377 - DEBUG - agent_label query returned:{'nh': {'type': 'interface', 'ref_count': '14', 'valid': 'true', 'policy': 'enabled', 'itf': 'tap5ef7ee05-99', 'mac': ['2:5e:f7:ee:5:99'], 'mcast': 'disabled', 'nh_index': '23', 'vxlan_flag': 'false', 'intf_flags': '1', 'isid': '0', 'learning_enabled': 'false', 'etree_leaf': 'false', 'layer2_control_word': 'false', 'crypt_all_traffic': 'false', 'crypt_path_available': 'false', 'crypt_interface': None}, 'label': '25', 'vxlan_id': '0', 'peer': '10.20.0.254', 'dest_vn_list': ['default-domain:ctest-FloatingipBasicTestSanity-22691735:ctest-fvn-06679837'], 'unresolved': 'false', 'sg_list': ['8000004'], 'supported_tunnel_type': 'MPLSoGRE MPLSoUDP ', 'active_tunnel_type': 'MPLSoUDP', 'stale': 'false', 'path_preference_data': {'sequence': '0', 'preference': '200', 'ecmp': 'true'}, 'active_label': '25', 'ecmp_hashing_fields': 'l3-source-address,l3-destination-address,l4-protocol,l4-source-port,l4-destination-port,', 'communities': None, 'peer_sequence_number': '1', 'etree_leaf': 'false', 'layer2_control_word': 'false', 'tag_list': None, 'inactive': 'false', 'origin_vn': None}
2025-07-31 13:54:15,377 - DEBUG - Route for FIP IP 107.145.123.4 is present in agent 10.0.0.65
2025-07-31 13:54:15,377 - DEBUG - FIP 107.145.123.4 verification for VM ctest-vn1_vm1_name-13019130 in Agent 10.0.0.65 passed
2025-07-31 13:54:15,377 - INFO - FIP ID 4b73cc8f-200c-4cd7-9bbf-34edec1e7518(107.145.123.4) validation in agents passed
2025-07-31 13:54:15,377 - DEBUG - Requesting: http://10.0.0.65:8082/floating-ip/4b73cc8f-200c-4cd7-9bbf-34edec1e7518
2025-07-31 13:54:15,386 - DEBUG - FIP 4b73cc8f-200c-4cd7-9bbf-34edec1e7518 is present in API server
2025-07-31 13:54:15,386 - INFO - FIP ID 4b73cc8f-200c-4cd7-9bbf-34edec1e7518(107.145.123.4) validation in API Server passed
2025-07-31 13:54:15,386 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2025-07-31 13:54:15,386 - DEBUG - Running remote_cmd, Cmd : ping -s 56 -c 3 -W 1 107.145.123.3, host_string: cirros@169.254.0.3, password: cubswin:)gateway: ubuntu@10.0.0.65, gateway password: c0ntrail123
2025-07-31 13:54:15,386 - DEBUG - ping -s 56 -c 3 -W 1 107.145.123.3
2025-07-31 13:54:18,333 - DEBUG - PING 107.145.123.3 (107.145.123.3): 56 data bytes
64 bytes from 107.145.123.3: seq=0 ttl=63 time=3.817 ms
64 bytes from 107.145.123.3: seq=1 ttl=63 time=0.846 ms
64 bytes from 107.145.123.3: seq=2 ttl=63 time=1.020 ms
--- 107.145.123.3 ping statistics ---
3 packets transmitted, 3 packets received, 0% packet loss
round-trip min/avg/max = 0.846/1.894/3.817 ms
2025-07-31 13:54:18,333 - INFO - Ping to IP 107.145.123.3 from VM ctest-vn1_vm1_name-13019130 passed
2025-07-31 13:54:18,334 - DEBUG - Disassociating port from FIP ID : 4b73cc8f-200c-4cd7-9bbf-34edec1e7518
2025-07-31 13:54:18,377 - DEBUG - Deleting FIP ID 4b73cc8f-200c-4cd7-9bbf-34edec1e7518
2025-07-31 13:54:18,430 - INFO - Deleting the FIP pool ctest-some-pool-30722045
2025-07-31 13:54:18,529 - DEBUG - Control-node Ifmap-view does not have FIP pool ctest-some-pool-30722045 information
2025-07-31 13:54:18,529 - INFO - Deleting VM ctest-fvn_vm1_name-89671020
2025-07-31 13:54:18,598 - INFO - Deleting VM ctest-vn1_vm1_name-13019130
2025-07-31 13:54:18,679 - INFO - Deleting VN ctest-vn1-13065168
2025-07-31 13:54:18,717 - DEBUG - VN 0be44c5a-a085-436c-aa55-f0c7b8149ad7 still in use: Unable to complete operation on network 0be44c5a-a085-436c-aa55-f0c7b8149ad7. There are one or more ports still in use on the network.
Neutron server returns request_ids: ['req-25752043-c16f-4468-99ca-db698dba8945']
2025-07-31 13:54:18,717 - WARNING - Deleting VN ctest-vn1-13065168 failed..Will retry
2025-07-31 13:54:20,843 - DEBUG - Response for deleting network ()
2025-07-31 13:54:20,843 - DEBUG - Requesting: http://10.0.0.65:8082/routing-instance/3579817c-4932-4085-9d5c-1b6fa2693ce3
2025-07-31 13:54:20,851 - DEBUG - Response Code: 404
2025-07-31 13:54:20,852 - DEBUG - Requesting: http://10.0.0.65:8082/domains
2025-07-31 13:54:20,857 - DEBUG - Requesting: http://10.0.0.65:8082/domain/c9e90f9b-d6f8-44b6-91f1-fa286b6f93b3
2025-07-31 13:54:20,913 - DEBUG - Requesting: http://10.0.0.65:8082/project/d6785366-f233-4b42-8732-9b79df501630
2025-07-31 13:54:20,991 - INFO - Validated that VN ctest-vn1-13065168 is not found in API Server
2025-07-31 13:54:21,001 - DEBUG - VN ctest-vn1-13065168 is not present in Agent 10.0.0.65
2025-07-31 13:54:21,001 - INFO - Validated that VN ctest-vn1-13065168 is not in any agent
2025-07-31 13:54:21,016 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-vn1-13065168 info
2025-07-31 13:54:21,016 - INFO - Deleting VN ctest-fvn-06679837
2025-07-31 13:54:21,122 - DEBUG - Response for deleting network ()
2025-07-31 13:54:21,123 - DEBUG - Requesting: http://10.0.0.65:8082/routing-instance/40f1b3eb-654d-4504-9180-b31cd5c72b30
2025-07-31 13:54:21,132 - DEBUG - Response Code: 404
2025-07-31 13:54:21,132 - DEBUG - Requesting: http://10.0.0.65:8082/domains
2025-07-31 13:54:21,137 - DEBUG - Requesting: http://10.0.0.65:8082/domain/c9e90f9b-d6f8-44b6-91f1-fa286b6f93b3
2025-07-31 13:54:21,192 - DEBUG - Requesting: http://10.0.0.65:8082/project/d6785366-f233-4b42-8732-9b79df501630
2025-07-31 13:54:21,282 - INFO - Validated that VN ctest-fvn-06679837 is not found in API Server
2025-07-31 13:54:21,295 - DEBUG - VN ctest-fvn-06679837 is not present in Agent 10.0.0.65
2025-07-31 13:54:21,295 - INFO - Validated that VN ctest-fvn-06679837 is not in any agent
2025-07-31 13:54:21,314 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-fvn-06679837 info
2025-07-31 13:54:21,568 - DEBUG - No XMPP flaps were noticed during the test
2025-07-31 13:54:21,568 - INFO - END TEST : test_floating_ip : PASSED[0:00:29]
2025-07-31 13:54:21,568 - INFO - --------------------------------------------------------------------------------
2025-07-31 13:54:22,257 - INFO - Deleted project: ctest-FloatingipBasicTestSanity-22691735, ID : d6785366-f233-4b42-8732-9b79df501630