Generated by TestNG with ReportNG at 22:31 PDT on Friday 01 July 2022
root@7c41cec37518 / Java 17.0.2 (Private Build) / Linux 4.14.281-212.502.amzn2.x86_64 (amd64)

REST: Item publication on PubSub node with message expiration using REST API - #2959

Suites · Log Output

Test duration : 44.951s

Passed Tests
tigase.tests.pubsub.TestRestApiWithMessageExpiration
testMessageExpiration 43.725s
2022-07-01 22:46:31 |

2022-07-01 22:46:31 | null / [TestClass name=class tigase.tests.pubsub.TestRestApiWithMessageExpiration]

2022-07-01 22:46:31 | ------------------------------------

2022-07-01 22:46:31 | [Mutex] isItemNotified: node_wlo6bg0204:exists :: false

2022-07-01 22:46:31 | [Mutex] waiting for: [node_wlo6bg0204:create_node]

2022-07-01 22:46:31 | [Mutex] received everything.

2022-07-01 22:46:31 | [Mutex] isItemNotified: node_wlo6bg0204:create_node:success :: true

2022-07-01 22:46:31 | [Mutex] waiting for: [node_wlo6bg0204:subscribe_node]

2022-07-01 22:46:31 | [Mutex] waiting for: [node_wlo6bg0204:subscribe_node]

2022-07-01 22:46:31 | [Mutex] received everything.

2022-07-01 22:46:31 | [Mutex] isItemNotified: node_wlo6bg0204:subscribe_node:success :: true

2022-07-01 22:46:31 |


===== publishing normal message (to online)


2022-07-01 22:46:31 | postRequest: POST /rest/pubsub/pubsub.test-domain.com/publish-item HTTP/1.1

2022-07-01 22:46:31 | command: <data><node>node_wlo6bg0204</node><entry><content>content_9no8ne0205</content></entry></data>

2022-07-01 22:46:31 | target: http://localhost:8088

2022-07-01 22:46:31 | entity: [Content-Type: application/xml,Content-Length: 93,Chunked: false]

2022-07-01 22:46:31 | entity: <data><node>node_wlo6bg0204</node><entry><content>content_9no8ne0205</content></entry></data>

2022-07-01 22:46:31 | response: HttpResponseProxy{HTTP/1.1 200 OK [Date: Sat, 02 Jul 2022 05:46:31 GMT, Transfer-encoding: chunked] ResponseEntityProxy{[Chunked: true]}}

2022-07-01 22:46:31 | response entity: <result><Note type="fixed"><value>Operation successful</value></Note><item-id type="fixed" label="Item ID"><value>0b3d2917-9a26-455a-9aff-d6e63794d0a0</value></item-id></result>

2022-07-01 22:46:31 | contains: true

2022-07-01 22:46:31 | [Mutex] waiting for: [user_regularh7isqa0203@test-domain.com:message:received:content_9no8ne0205]

2022-07-01 22:46:31 | [Mutex] received everything.

2022-07-01 22:46:31 | [Mutex] isItemNotified: user_regularh7isqa0203@test-domain.com:message:received:content_9no8ne0205 :: true

2022-07-01 22:46:31 |


===== publishing already old message - expecting message being filtered out (to online)


2022-07-01 22:46:31 | postRequest: POST /rest/pubsub/pubsub.test-domain.com/publish-item HTTP/1.1

2022-07-01 22:46:31 | command: <data><node>node_wlo6bg0204</node><expire-at>2022-07-02T05:46:26Z</expire-at><entry><content>content_fmeam0206</content></entry></data>

2022-07-01 22:46:31 | target: http://localhost:8088

2022-07-01 22:46:31 | entity: [Content-Type: application/xml,Content-Length: 135,Chunked: false]

2022-07-01 22:46:31 | entity: <data><node>node_wlo6bg0204</node><expire-at>2022-07-02T05:46:26Z</expire-at><entry><content>content_fmeam0206</content></entry></data>

2022-07-01 22:46:31 | response: HttpResponseProxy{HTTP/1.1 200 OK [Date: Sat, 02 Jul 2022 05:46:31 GMT, Transfer-encoding: chunked] ResponseEntityProxy{[Chunked: true]}}

2022-07-01 22:46:31 | response entity: <result><Note type="fixed"><value>Operation successful</value></Note><item-id type="fixed" label="Item ID"><value>cff45160-713c-42e4-89e3-5a83fb5edb52</value></item-id></result>

2022-07-01 22:46:31 | contains: true

2022-07-01 22:46:31 | [Mutex] waiting for: [user_regularh7isqa0203@test-domain.com:message:received:content_fmeam0206]

2022-07-01 22:46:46 | [Mutex] timeout. Not received [user_regularh7isqa0203@test-domain.com:message:received:content_fmeam0206]

2022-07-01 22:46:46 | [Mutex] isItemNotified: user_regularh7isqa0203@test-domain.com:message:received:content_fmeam0206 :: false

2022-07-01 22:46:46 |


===== publishing normal message (to offline)


2022-07-01 22:46:46 | postRequest: POST /rest/pubsub/pubsub.test-domain.com/publish-item HTTP/1.1

2022-07-01 22:46:46 | command: <data><node>node_wlo6bg0204</node><entry><content>content_3qn84o0207</content></entry></data>

2022-07-01 22:46:46 | target: http://localhost:8088

2022-07-01 22:46:46 | entity: [Content-Type: application/xml,Content-Length: 93,Chunked: false]

2022-07-01 22:46:46 | entity: <data><node>node_wlo6bg0204</node><entry><content>content_3qn84o0207</content></entry></data>

2022-07-01 22:46:46 | response: HttpResponseProxy{HTTP/1.1 200 OK [Date: Sat, 02 Jul 2022 05:46:46 GMT, Transfer-encoding: chunked] ResponseEntityProxy{[Chunked: true]}}

2022-07-01 22:46:46 | response entity: <result><Note type="fixed"><value>Operation successful</value></Note><item-id type="fixed" label="Item ID"><value>b11fc4c9-a1c2-4fea-b79b-3cc0eee56888</value></item-id></result>

2022-07-01 22:46:46 | contains: true

2022-07-01 22:46:51 | tigase.jaxmpp.j2se.Jaxmpp.createConnector: Using SocketConnector

2022-07-01 22:46:51 | tigase.jaxmpp.j2se.connectors.socket.SocketConnector.printLog: [scid=480 thread=1] DNS entry stored in session object: localhost:5222

2022-07-01 22:46:51 | tigase.jaxmpp.j2se.connectors.socket.SocketConnector.printLog: [scid=480 thread=1] Opening connection to localhost/127.0.0.1:5222

2022-07-01 22:46:52 | [Mutex] waiting for: [user_regularh7isqa0203@test-domain.com:message:received:content_3qn84o0207]

2022-07-01 22:46:52 | [Mutex] received everything.

2022-07-01 22:46:52 | [Mutex] isItemNotified: user_regularh7isqa0203@test-domain.com:message:received:content_3qn84o0207 :: true

2022-07-01 22:46:52 |


===== publishing already old message - expecting message being filtered out (to offline)


2022-07-01 22:46:52 | [Mutex] received everything.

2022-07-01 22:46:52 | [Mutex] isItemNotified: node_wlo6bg0204:subscribe_node:success :: true

2022-07-01 22:46:52 | postRequest: POST /rest/pubsub/pubsub.test-domain.com/publish-item HTTP/1.1

2022-07-01 22:46:52 | command: <data><node>node_wlo6bg0204</node><expire-at>2022-07-02T05:46:57Z</expire-at><entry><content>content_w8w3w70208</content></entry></data>

2022-07-01 22:46:52 | target: http://localhost:8088

2022-07-01 22:46:52 | entity: [Content-Type: application/xml,Content-Length: 136,Chunked: false]

2022-07-01 22:46:52 | entity: <data><node>node_wlo6bg0204</node><expire-at>2022-07-02T05:46:57Z</expire-at><entry><content>content_w8w3w70208</content></entry></data>

2022-07-01 22:46:52 | response: HttpResponseProxy{HTTP/1.1 200 OK [Date: Sat, 02 Jul 2022 05:46:52 GMT, Transfer-encoding: chunked] ResponseEntityProxy{[Chunked: true]}}

2022-07-01 22:46:52 | response entity: <result><Note type="fixed"><value>Operation successful</value></Note><item-id type="fixed" label="Item ID"><value>62f4afe2-1a71-463e-be6a-2a52dffe49ac</value></item-id></result>

2022-07-01 22:46:52 | contains: true

2022-07-01 22:47:00 | tigase.jaxmpp.j2se.Jaxmpp.createConnector: Using SocketConnector

2022-07-01 22:47:00 | tigase.jaxmpp.j2se.connectors.socket.SocketConnector.printLog: [scid=481 thread=1] DNS entry stored in session object: localhost:5222

2022-07-01 22:47:00 | tigase.jaxmpp.j2se.connectors.socket.SocketConnector.printLog: [scid=481 thread=1] Opening connection to localhost/127.0.0.1:5222

2022-07-01 22:47:00 | [Mutex] waiting for: [user_regularh7isqa0203@test-domain.com:message:received:content_w8w3w70208]

2022-07-01 22:47:00 | [Mutex] waiting for: [user_regularh7isqa0203@test-domain.com:message:received:content_w8w3w70208]

2022-07-01 22:47:00 | [Mutex] waiting for: [user_regularh7isqa0203@test-domain.com:message:received:content_w8w3w70208]

2022-07-01 22:47:15 | [Mutex] timeout. Not received [user_regularh7isqa0203@test-domain.com:message:received:content_w8w3w70208]

2022-07-01 22:47:15 | [Mutex] received everything.

2022-07-01 22:47:15 | [Mutex] isItemNotified: user_regularh7isqa0203@test-domain.com:message:received:content_w8w3w70208 :: false

2022-07-01 22:47:15 | [Mutex] isItemNotified: admin@test-domain.com:message:received:content_w8w3w70208 :: true