13 Replies Latest reply on Sep 16, 2016 10:26 AM by acorreia RSS
    rkelly Newbie

    Error when deploying EMS with Pi temp humidity sensor.

    (I am not the administrator for my instance)

     

    In part 5 of the Raspberry Pi Weather Application project, I get an error when trying to connect the Pi to ThingWorx. the commands I ran are:

     

    java -jar ./temperature-thing-jar-with-dependencies.jar ws://xxxxxx.clould.thingworx.com:80//Thingworx/ws b7b95994-865b-446c-ace7-b9438bdf1d80

    and

    java -jar ./temperature-thing-jar-with-dependencies.jar wss://xxxxxx.clould.thingworx.com//Thingworx/ws b7b95994-865b-446c-ace7-b9438bdf1d80

     

    Also, when I run the simulated command from my desktop, I receive the message that the system cannot find the file, but the .jar file is clearly where it is supposed to be. Any help will be appreciated. The errors from the Pi and Windows are shown below:

     

    From my Desktop:

    C:\temperature-thing\temperature-thing\target>java -jar ./temperature-thing-jar-with-dependencies.jar wss://xxxxxxxx.cloud.thingworx.com//Thingworx/WS</thingworx b7b95994-865b-446c-ace7-b9438bdf1d80 simulated

    The system cannot find the file specified.

     

    C:\temperature-thing\temperature-thing\target>java -jar C:\temperature-thing\temperature-thing\target/temperature-thing-jar-with-dependencies.jar wss://xxxxxxxxx.cloud.thingworx.com//Thingworx/WS</thingworx b7b95994-865b-446c-ace7-b9438bdf1d80 simulated

    The system cannot find the file specified.

     

    From my Pi:

     

    pi@raspberrypi ~ $ java -jar ./temperature-thing-jar-with-dependencies.jar ws://xxxxxx.clould.thingworx.com:80//Thingworx/ws b7b95994-865b-446c-ace7-b9438bdf1d80

     

    19:19:14.662 [main] DEBUG c.p.tempthing.BaseEdgeServer - EDGE SERVER STARTING....

     

    19:19:15.199 [main] INFO  c.t.c.c.p.ClientMessageProcessor - Created new ClientMessageProcessor [minPoolSize: 4, maxPoolSize: 10, maxThreadLife: 10000, maxQueueSize: 1000]

     

    19:19:15.577 [main] DEBUG com.ptcmanaged.tempthing.Main - Connecting to ws://xxxxx.clould.thingworx.com:80//Thingworx/ws using key b7b95994-865b-446c-ace7-b9438bdf1d80

     

    19:19:15.657 [main] DEBUG i.n.u.i.l.InternalLoggerFactory - Using SLF4J as the default logging framework

     

    19:19:15.684 [main] DEBUG i.n.c.MultithreadEventLoopGroup - -Dio.netty.eventLoopThreads: 8

     

    19:19:15.748 [main] DEBUG i.n.util.internal.PlatformDependent0 - sun.nio.ch.DirectBuffer.cleaner(): available

     

    19:19:15.754 [main] DEBUG i.n.util.internal.PlatformDependent0 - java.nio.Buffer.address: available

     

    19:19:15.759 [main] DEBUG i.n.util.internal.PlatformDependent0 - sun.misc.Unsafe.theUnsafe: available

     

    19:19:15.763 [main] DEBUG i.n.util.internal.PlatformDependent0 - sun.misc.Unsafe.copyMemory: available

     

    19:19:15.766 [main] DEBUG i.n.util.internal.PlatformDependent0 - java.nio.Bits.unaligned: false

     

    19:19:15.808 [main] DEBUG i.n.util.internal.PlatformDependent - UID: 1000

     

    19:19:15.810 [main] DEBUG i.n.util.internal.PlatformDependent - Java version: 8

     

    19:19:15.811 [main] DEBUG i.n.util.internal.PlatformDependent - -Dio.netty.noUnsafe: false

     

    19:19:15.811 [main] DEBUG i.n.util.internal.PlatformDependent - sun.misc.Unsafe: available

     

    19:19:15.814 [main] DEBUG i.n.util.internal.PlatformDependent - -Dio.netty.noJavassist: false

     

    19:19:15.820 [main] DEBUG i.n.util.internal.PlatformDependent - Javassist: unavailable

     

    19:19:15.821 [main] DEBUG i.n.util.internal.PlatformDependent - You don't have Javassist in your class path or you don't have enough permission to load dynamically generated classes.  Please check the configuration for better performance.

     

    19:19:15.822 [main] DEBUG i.n.util.internal.PlatformDependent - -Dio.netty.tmpdir: /tmp (java.io.tmpdir)

     

    19:19:15.824 [main] DEBUG i.n.util.internal.PlatformDependent - -Dio.netty.bitMode: 32 (sun.arch.data.model)

     

    19:19:15.824 [main] DEBUG i.n.util.internal.PlatformDependent - -Dio.netty.noPreferDirect: false

     

    19:19:15.934 [main] DEBUG io.netty.channel.nio.NioEventLoop - -Dio.netty.noKeySetOptimization: false

     

    19:19:15.935 [main] DEBUG io.netty.channel.nio.NioEventLoop - -Dio.netty.selectorAutoRebuildThreshold: 512

     

    19:19:16.064 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.numHeapArenas: 1

     

    19:19:16.065 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.numDirectArenas: 1

     

    19:19:16.065 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.pageSize: 8192

     

    19:19:16.066 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.maxOrder: 11

     

    19:19:16.066 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.chunkSize: 16777216

     

    19:19:16.066 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.tinyCacheSize: 512

     

    19:19:16.067 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.smallCacheSize: 256

     

    19:19:16.067 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.normalCacheSize: 64

     

    19:19:16.067 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.maxCachedBufferCapacity: 32768

     

    19:19:16.068 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.cacheTrimInterval: 8192

     

    19:19:16.068 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.cacheCleanupInterval: 5000 ms

     

    19:19:16.136 [main] DEBUG c.t.c.c.e.m.CommunicationEndpointMonitorTask - Initializing CommunicationEndpoint Connection Monitor...

     

    19:19:16.138 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.m.CommunicationEndpointMonitorTask - CommunicationEndpoint Monitor - checking for disconnected endpoints

     

    19:19:16.139 [Client-EndpointMonitor-1] INFO  c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint not connected [name: EP_0, id: 0]. Attempting [re]connect...

     

    19:19:16.142 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.ClientCommunicationEndpoint - Clearing endpoint authentication data [id: 0]

     

    19:19:16.143 [Client-EndpointMonitor-1] INFO  c.t.c.c.e.ClientCommunicationEndpoint - Needed to refill connections on client endpoint [id: 0] : [active: 0, max: 1]

     

    19:19:16.351 [Client-EndpointMonitor-1] DEBUG i.n.util.internal.ThreadLocalRandom - -Dio.netty.initialSeedUniquifier: 0x1e0de45765c53dc6

     

    19:19:16.393 [Client-EndpointMonitor-1] DEBUG i.n.channel.ChannelOutboundBuffer - -Dio.netty.threadLocalDirectBufferSize: 65536

     

    19:19:16.399 [Client-EndpointMonitor-1] DEBUG io.netty.util.Recycler - -Dio.netty.recycler.maxCapacity.default: 262144

     

    19:19:16.491 [Client-EndpointMonitor-1] DEBUG io.netty.buffer.ByteBufUtil - -Dio.netty.allocator.type: unpooled

     

    19:19:16.744 [NettyClient-NIO-1] DEBUG io.netty.util.ResourceLeakDetector - -Dio.netty.leakDetectionLevel: simple

     

    19:19:26.552 [Client-EndpointMonitor-1] INFO  c.t.c.c.c.n.NettyClientConnectionFactory - forcing underlying tcp channel closed [is open: false, is active: false]

     

    19:19:26.558 [Client-EndpointMonitor-1] ERROR c.t.c.c.e.ClientCommunicationEndpoint - Refilling connections on [endpoint 0, uri:

    ws://stevenscollege.clould.thingworx.com:80//Thingworx/ws] failed : timeout waiting for websocket handshake to complete

     

    19:19:26.560 [Client-EndpointMonitor-1] INFO  c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint reconnection was unsuccessful [name: EP_0, id: 0]

      • Re: Error when deploying EMS with Pi temp humidity sensor.
        ianban Creator

        Hi


        1st question is the instance that you are connecting to HTTP or HTTPS?

        2nd question : are you running the command on the pi from the directory where the jar file resides? I'll assume that you are....


        If your ThingWorx instance is HTTP, then:

        java -jar temperature-thing-jar-with-dependencies.jar ws://xxxxxx.clould.thingworx.com:80/Thingworx/ws b7b95994-865b-446c-ace7-b9438bdf1d80


        Should work.


        If it's HTTPS (and using default HTTPS port) then:

         

        java -jar temperature-thing-jar-with-dependencies.jar wss://xxxxxx.clould.thingworx.com:443/Thingworx/ws b7b95994-865b-446c-ace7-b9438bdf1d80


        should work.


        In both cases I've taken out the ./ before the jar file name (as I'm assuming you're in that directory) and changed // to / before "Thingworx" in the URL. For the HTTPS example I've also added the port to the URL.


        In the windows example, it won't like the ./ so take that out and also make the same updates to your URL as above.


        Regards


        Ian

          • Re: Error when deploying EMS with Pi temp humidity sensor.
            rkelly Newbie

            After making the suggested changes and ensuring the instance is http and that I am running the command from the proper directory, the problem still persists. I am at a loss of where I can go from here. Could it be the settings on my schools network? Do the steps that take place on ThingWorx have to be done as an administrator? My results are below, thank you.

             

             

            pi@raspberrypi ~ $ java -jar temperature-thing-jar-with-dependencies.jar ws://xxxxxxx.cloud.thingworx.com:80/Thingworx/ws b7b95994-865b-446c-ace7-b9438bdf1d80


            19:06:55.210 [main] DEBUG c.p.tempthing.BaseEdgeServer - EDGE SERVER STARTING....

            19:06:55.746 [main] INFO  c.t.c.c.p.ClientMessageProcessor - Created new ClientMessageProcessor [minPoolSize: 4, maxPoolSize: 10, maxThreadLife: 10000, maxQueueSize: 1000]

            19:06:56.124 [main] DEBUG com.ptcmanaged.tempthing.Main - Connecting to ws://stevenscollege.cloud.thingworx.com:80/Thingworx/ws using key b7b95994-865b-446c-ace7-b9438bdf1d80

            19:06:56.197 [main] DEBUG i.n.u.i.l.InternalLoggerFactory - Using SLF4J as the default logging framework

            19:06:56.229 [main] DEBUG i.n.c.MultithreadEventLoopGroup - -Dio.netty.eventLoopThreads: 8

            19:06:56.288 [main] DEBUG i.n.util.internal.PlatformDependent0 - sun.nio.ch.DirectBuffer.cleaner(): available

            19:06:56.295 [main] DEBUG i.n.util.internal.PlatformDependent0 - java.nio.Buffer.address: available

            19:06:56.298 [main] DEBUG i.n.util.internal.PlatformDependent0 - sun.misc.Unsafe.theUnsafe: available

            19:06:56.302 [main] DEBUG i.n.util.internal.PlatformDependent0 - sun.misc.Unsafe.copyMemory: available

            19:06:56.305 [main] DEBUG i.n.util.internal.PlatformDependent0 - java.nio.Bits.unaligned: false

            19:06:56.341 [main] DEBUG i.n.util.internal.PlatformDependent - UID: 1000

            19:06:56.343 [main] DEBUG i.n.util.internal.PlatformDependent - Java version: 8

            19:06:56.345 [main] DEBUG i.n.util.internal.PlatformDependent - -Dio.netty.noUnsafe: false

            19:06:56.345 [main] DEBUG i.n.util.internal.PlatformDependent - sun.misc.Unsafe: available

            19:06:56.348 [main] DEBUG i.n.util.internal.PlatformDependent - -Dio.netty.noJavassist: false

            19:06:56.354 [main] DEBUG i.n.util.internal.PlatformDependent - Javassist: unavailable

            19:06:56.355 [main] DEBUG i.n.util.internal.PlatformDependent - You don't have Javassist in your class path or you don't have enough permission to load dynamically generated classes.  Please check the configuration for better performance.

            19:06:56.357 [main] DEBUG i.n.util.internal.PlatformDependent - -Dio.netty.tmpdir: /tmp (java.io.tmpdir)

            19:06:56.358 [main] DEBUG i.n.util.internal.PlatformDependent - -Dio.netty.bitMode: 32 (sun.arch.data.model)

            19:06:56.358 [main] DEBUG i.n.util.internal.PlatformDependent - -Dio.netty.noPreferDirect: false

            19:06:56.467 [main] DEBUG io.netty.channel.nio.NioEventLoop - -Dio.netty.noKeySetOptimization: false

            19:06:56.468 [main] DEBUG io.netty.channel.nio.NioEventLoop - -Dio.netty.selectorAutoRebuildThreshold: 512

            19:06:56.596 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.numHeapArenas: 1

            19:06:56.596 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.numDirectArenas: 1

            19:06:56.597 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.pageSize: 8192

            19:06:56.597 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.maxOrder: 11

            19:06:56.598 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.chunkSize: 16777216

            19:06:56.598 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.tinyCacheSize: 512

            19:06:56.599 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.smallCacheSize: 256

            19:06:56.599 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.normalCacheSize: 64

            19:06:56.599 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.maxCachedBufferCapacity: 32768

            19:06:56.600 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.cacheTrimInterval: 8192

            19:06:56.600 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.cacheCleanupInterval: 5000 ms

            19:06:56.670 [main] DEBUG c.t.c.c.e.m.CommunicationEndpointMonitorTask - Initializing CommunicationEndpoint Connection Monitor...

            19:06:56.672 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.m.CommunicationEndpointMonitorTask - CommunicationEndpoint Monitor - checking for disconnected endpoints

            19:06:56.673 [Client-EndpointMonitor-1] INFO  c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint not connected [name: EP_0, id: 0]. Attempting [re]connect...

            19:06:56.675 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.ClientCommunicationEndpoint - Clearing endpoint authentication data [id: 0]

            19:06:56.675 [Client-EndpointMonitor-1] INFO  c.t.c.c.e.ClientCommunicationEndpoint - Needed to refill connections on client endpoint [id: 0] : [active: 0, max: 1]

            19:06:56.882 [Client-EndpointMonitor-1] DEBUG i.n.util.internal.ThreadLocalRandom - -Dio.netty.initialSeedUniquifier: 0xaf4b25c97bc68637

            19:06:56.924 [Client-EndpointMonitor-1] DEBUG i.n.channel.ChannelOutboundBuffer - -Dio.netty.threadLocalDirectBufferSize: 65536

            19:06:56.930 [Client-EndpointMonitor-1] DEBUG io.netty.util.Recycler - -Dio.netty.recycler.maxCapacity.default: 262144

            19:06:57.028 [Client-EndpointMonitor-1] DEBUG io.netty.buffer.ByteBufUtil - -Dio.netty.allocator.type: unpooled

            19:06:57.267 [NettyClient-NIO-1] DEBUG io.netty.util.ResourceLeakDetector - -Dio.netty.leakDetectionLevel: simple

            19:06:57.509 [NettyClient-NIO-1] DEBUG c.t.c.c.c.n.ThingworxClientConnectionHandler - WebSocket Channel is connected [is open: true]

            19:06:57.535 [NettyClient-NIO-1] DEBUG i.n.h.c.h.w.WebSocketClientHandshaker13 - WebSocket version 13 client handshake key: 8v0aaujx8bk1wxBU+Sptwg==, expected response: yvddUO+WYI8WlfnvdoyW6leviwY=

            19:07:07.088 [Client-EndpointMonitor-1] INFO  c.t.c.c.c.n.NettyClientConnectionFactory - forcing underlying tcp channel closed [is open: false, is active: false]

            19:07:07.093 [Client-EndpointMonitor-1] ERROR c.t.c.c.e.ClientCommunicationEndpoint - Refilling connections on [endpoint 0, uri: ws://stevenscollege.cloud.thingworx.com:80/Thingworx/ws] failed : timeout waiting for websocket handshake to complete

            19:07:07.094 [Client-EndpointMonitor-1] INFO  c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint reconnection was unsuccessful [name: EP_0, id: 0]

              • Re: Error when deploying EMS with Pi temp humidity sensor.
                ianban Creator

                Hi

                 

                As you put the URL and appKey in the above I tested it... it may be worth creating a new AppKey and removing the existing one.

                 

                I can access your server, the user that the AppKey is linked to doesn't have many permissions.... that may not help, but isn't your main problem. I tested with a simulator that I had lying around... it connected but then was giving "Not authorised for service invoke" errors.. which is linked to your user setup.

                 

                If the school has a proxy server, that may be causing issues, I'm not sure what the Academic program has in place for configuring for these. I'll ping one of the team and see if they can advise you...

                 

                Regards

                 

                Ian

                • Re: Error when deploying EMS with Pi temp humidity sensor.
                  aanjan Heavyweight Champ

                  Ryan, if it times out for websocket handshake to complete, it should be something related to your network. Is there any chance you can try this outside of that specific network?

                   

                  On a side note, this might be a long shot, you have ws on your uri; switch that to WS and retry, so that it reads - ws://xxxxxxx.cloud.thingworx.com:80/Thingworx/WS

                    • Re: Error when deploying EMS with Pi temp humidity sensor.
                      rkelly Newbie

                      Wow changing ws to WS was the solution, thank you.

                      • Re: Error when deploying EMS with Pi temp humidity sensor.
                        pnali Explorer

                        Hi,

                         

                        i'm facing the same issue with endpoint reconnection failing. i tried replacing ws with WS but still facing the issue. can i get a suggestion to resolve this?

                          • Re: Error when deploying EMS with Pi temp humidity sensor.
                            aanjan Heavyweight Champ

                            Preethi, can you post your entire log as well? If your issue looks to be different, you might want to create a new thread, just so we can track and resolve different questions/ issues individually

                              • Re: Error when deploying EMS with Pi temp humidity sensor.
                                pnali Explorer

                                I am getting the following result:

                                 

                                Simulated Data supported...........

                                SimulateTimer.Set.run() Tue Apr 26 09:49:28 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:49:28 IST 2016

                                09:49:28.390 [main] INFO c.t.c.c.p.ClientMessageProcessor - Created new ClientMessageProcessor [minPoolSize: 4, maxPoolSize: 10, maxThreadLife: 10000, maxQueueSize: 1000]

                                09:49:28.540 [main] DEBUG i.n.u.i.l.InternalLoggerFactory - Using SLF4J as the default logging framework

                                09:49:28.557 [main] DEBUG i.n.c.MultithreadEventLoopGroup - -Dio.netty.eventLoopThreads: 8

                                09:49:28.596 [main] DEBUG i.n.util.internal.PlatformDependent0 - sun.nio.ch.DirectBuffer.cleaner(): available

                                09:49:28.597 [main] DEBUG i.n.util.internal.PlatformDependent0 - java.nio.Buffer.address: available

                                09:49:28.599 [main] DEBUG i.n.util.internal.PlatformDependent0 - sun.misc.Unsafe.theUnsafe: available

                                09:49:28.600 [main] DEBUG i.n.util.internal.PlatformDependent0 - sun.misc.Unsafe.copyMemory: available

                                09:49:28.601 [main] DEBUG i.n.util.internal.PlatformDependent0 - java.nio.Bits.unaligned: true

                                09:49:28.602 [main] DEBUG i.n.util.internal.PlatformDependent - Platform: Windows

                                09:49:28.607 [main] DEBUG i.n.util.internal.PlatformDependent - Java version: 8

                                09:49:28.607 [main] DEBUG i.n.util.internal.PlatformDependent - -Dio.netty.noUnsafe: false

                                09:49:28.608 [main] DEBUG i.n.util.internal.PlatformDependent - sun.misc.Unsafe: available

                                09:49:28.609 [main] DEBUG i.n.util.internal.PlatformDependent - -Dio.netty.noJavassist: false

                                09:49:28.610 [main] DEBUG i.n.util.internal.PlatformDependent - Javassist: unavailable

                                09:49:28.611 [main] DEBUG i.n.util.internal.PlatformDependent - You don't have Javassist in your class path or you don't have enough permission to load dynamically generated classes. Please check the configuration for better performance.

                                09:49:28.611 [main] DEBUG i.n.util.internal.PlatformDependent - -Dio.netty.tmpdir: C:\Users\PREETH~1\AppData\Local\Temp (java.io.tmpdir)

                                09:49:28.612 [main] DEBUG i.n.util.internal.PlatformDependent - -Dio.netty.bitMode: 64 (sun.arch.data.model)

                                09:49:28.612 [main] DEBUG i.n.util.internal.PlatformDependent - -Dio.netty.noPreferDirect: false

                                09:49:28.649 [main] DEBUG io.netty.channel.nio.NioEventLoop - -Dio.netty.noKeySetOptimization: false

                                09:49:28.649 [main] DEBUG io.netty.channel.nio.NioEventLoop - -Dio.netty.selectorAutoRebuildThreshold: 512

                                09:49:28.972 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.numHeapArenas: 4

                                09:49:28.972 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.numDirectArenas: 4

                                09:49:28.972 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.pageSize: 8192

                                09:49:28.973 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.maxOrder: 11

                                09:49:28.973 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.chunkSize: 16777216

                                09:49:28.973 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.tinyCacheSize: 512

                                09:49:28.973 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.smallCacheSize: 256

                                09:49:28.973 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.normalCacheSize: 64

                                09:49:28.973 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.maxCachedBufferCapacity: 32768

                                09:49:28.973 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.cacheTrimInterval: 8192

                                09:49:28.973 [main] DEBUG i.n.buffer.PooledByteBufAllocator - -Dio.netty.allocator.cacheCleanupInterval: 5000 ms

                                09:49:28.991 [main] DEBUG c.t.c.c.e.m.CommunicationEndpointMonitorTask - Initializing CommunicationEndpoint Connection Monitor...

                                09:49:28.994 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.m.CommunicationEndpointMonitorTask - CommunicationEndpoint Monitor - checking for disconnected endpoints

                                09:49:28.995 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint not connected [name: HvacGateway, id: 0]. Attempting [re]connect...

                                09:49:28.995 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.ClientCommunicationEndpoint - Clearing endpoint authentication data [id: 0]

                                09:49:28.996 [Client-EndpointMonitor-1] INFO c.t.c.c.e.ClientCommunicationEndpoint - Needed to refill connections on client endpoint [id: 0] : [active: 0, max: 1]

                                09:49:29.092 [Client-EndpointMonitor-1] DEBUG i.n.util.internal.ThreadLocalRandom - -Dio.netty.initialSeedUniquifier: 0xbf101f470ca3ac88

                                09:49:29.106 [Client-EndpointMonitor-1] DEBUG i.n.channel.ChannelOutboundBuffer - -Dio.netty.threadLocalDirectBufferSize: 65536

                                09:49:29.107 [Client-EndpointMonitor-1] DEBUG io.netty.util.Recycler - -Dio.netty.recycler.maxCapacity.default: 262144

                                09:49:29.143 [Client-EndpointMonitor-1] DEBUG io.netty.buffer.ByteBufUtil - -Dio.netty.allocator.type: unpooled

                                09:49:29.240 [NettyClient-NIO-1] DEBUG io.netty.util.ResourceLeakDetector - -Dio.netty.leakDetectionLevel: simple

                                SimulateTimer.ReSet.run() Tue Apr 26 09:49:38 IST 2016

                                09:49:39.153 [Client-EndpointMonitor-1] INFO c.t.c.c.c.n.NettyClientConnectionFactory - forcing underlying tcp channel closed [is open: false, is active: false]

                                09:49:39.154 [Client-EndpointMonitor-1] ERROR c.t.c.c.e.ClientCommunicationEndpoint - Refilling connections on [endpoint 0, uri: ws://localhost:80/Thingworx/WS] failed : timeout waiting for websocket handshake to complete

                                09:49:39.155 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint reconnection was unsuccessful [name: HvacGateway, id: 0]

                                SimulateTimer.Set.run() Tue Apr 26 09:49:40 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:49:48 IST 2016

                                SimulateTimer.Set.run() Tue Apr 26 09:49:52 IST 2016

                                09:49:54.154 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.m.CommunicationEndpointMonitorTask - CommunicationEndpoint Monitor - checking for disconnected endpoints

                                09:49:54.154 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint not connected [name: HvacGateway, id: 0]. Attempting [re]connect...

                                09:49:54.154 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.ClientCommunicationEndpoint - Clearing endpoint authentication data [id: 0]

                                09:49:54.154 [Client-EndpointMonitor-1] INFO c.t.c.c.e.ClientCommunicationEndpoint - Needed to refill connections on client endpoint [id: 0] : [active: 0, max: 1]

                                SimulateTimer.ReSet.run() Tue Apr 26 09:49:58 IST 2016

                                09:50:04.155 [Client-EndpointMonitor-1] INFO c.t.c.c.c.n.NettyClientConnectionFactory - forcing underlying tcp channel closed [is open: false, is active: false]

                                09:50:04.159 [Client-EndpointMonitor-1] ERROR c.t.c.c.e.ClientCommunicationEndpoint - Refilling connections on [endpoint 0, uri: ws://localhost:80/Thingworx/WS] failed : timeout waiting for websocket handshake to complete

                                09:50:04.159 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint reconnection was unsuccessful [name: HvacGateway, id: 0]

                                SimulateTimer.Set.run() Tue Apr 26 09:50:04 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:50:08 IST 2016

                                SimulateTimer.Set.run() Tue Apr 26 09:50:16 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:50:18 IST 2016

                                09:50:19.159 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.m.CommunicationEndpointMonitorTask - CommunicationEndpoint Monitor - checking for disconnected endpoints

                                09:50:19.159 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint not connected [name: HvacGateway, id: 0]. Attempting [re]connect...

                                09:50:19.159 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.ClientCommunicationEndpoint - Clearing endpoint authentication data [id: 0]

                                09:50:19.159 [Client-EndpointMonitor-1] INFO c.t.c.c.e.ClientCommunicationEndpoint - Needed to refill connections on client endpoint [id: 0] : [active: 0, max: 1]

                                SimulateTimer.Set.run() Tue Apr 26 09:50:28 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:50:28 IST 2016

                                09:50:29.161 [Client-EndpointMonitor-1] INFO c.t.c.c.c.n.NettyClientConnectionFactory - forcing underlying tcp channel closed [is open: false, is active: false]

                                09:50:29.161 [Client-EndpointMonitor-1] ERROR c.t.c.c.e.ClientCommunicationEndpoint - Refilling connections on [endpoint 0, uri: ws://localhost:80/Thingworx/WS] failed : timeout waiting for websocket handshake to complete

                                09:50:29.161 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint reconnection was unsuccessful [name: HvacGateway, id: 0]

                                SimulateTimer.ReSet.run() Tue Apr 26 09:50:38 IST 2016

                                SimulateTimer.Set.run() Tue Apr 26 09:50:40 IST 2016

                                09:50:44.161 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.m.CommunicationEndpointMonitorTask - CommunicationEndpoint Monitor - checking for disconnected endpoints

                                09:50:44.161 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint not connected [name: HvacGateway, id: 0]. Attempting [re]connect...

                                09:50:44.161 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.ClientCommunicationEndpoint - Clearing endpoint authentication data [id: 0]

                                09:50:44.161 [Client-EndpointMonitor-1] INFO c.t.c.c.e.ClientCommunicationEndpoint - Needed to refill connections on client endpoint [id: 0] : [active: 0, max: 1]

                                SimulateTimer.ReSet.run() Tue Apr 26 09:50:48 IST 2016

                                SimulateTimer.Set.run() Tue Apr 26 09:50:52 IST 2016

                                09:50:54.162 [Client-EndpointMonitor-1] INFO c.t.c.c.c.n.NettyClientConnectionFactory - forcing underlying tcp channel closed [is open: false, is active: false]

                                09:50:54.162 [Client-EndpointMonitor-1] ERROR c.t.c.c.e.ClientCommunicationEndpoint - Refilling connections on [endpoint 0, uri: ws://localhost:80/Thingworx/WS] failed : timeout waiting for websocket handshake to complete

                                09:50:54.162 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint reconnection was unsuccessful [name: HvacGateway, id: 0]

                                SimulateTimer.ReSet.run() Tue Apr 26 09:50:58 IST 2016

                                SimulateTimer.Set.run() Tue Apr 26 09:51:04 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:51:08 IST 2016

                                09:51:09.161 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.m.CommunicationEndpointMonitorTask - CommunicationEndpoint Monitor - checking for disconnected endpoints

                                09:51:09.161 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint not connected [name: HvacGateway, id: 0]. Attempting [re]connect...

                                09:51:09.161 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.ClientCommunicationEndpoint - Clearing endpoint authentication data [id: 0]

                                09:51:09.162 [Client-EndpointMonitor-1] INFO c.t.c.c.e.ClientCommunicationEndpoint - Needed to refill connections on client endpoint [id: 0] : [active: 0, max: 1]

                                SimulateTimer.Set.run() Tue Apr 26 09:51:16 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:51:18 IST 2016

                                09:51:19.165 [Client-EndpointMonitor-1] INFO c.t.c.c.c.n.NettyClientConnectionFactory - forcing underlying tcp channel closed [is open: false, is active: false]

                                09:51:19.165 [Client-EndpointMonitor-1] ERROR c.t.c.c.e.ClientCommunicationEndpoint - Refilling connections on [endpoint 0, uri: ws://localhost:80/Thingworx/WS] failed : timeout waiting for websocket handshake to complete

                                09:51:19.165 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint reconnection was unsuccessful [name: HvacGateway, id: 0]

                                SimulateTimer.Set.run() Tue Apr 26 09:51:28 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:51:28 IST 2016

                                09:51:34.165 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.m.CommunicationEndpointMonitorTask - CommunicationEndpoint Monitor - checking for disconnected endpoints

                                09:51:34.165 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint not connected [name: HvacGateway, id: 0]. Attempting [re]connect...

                                09:51:34.165 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.ClientCommunicationEndpoint - Clearing endpoint authentication data [id: 0]

                                09:51:34.165 [Client-EndpointMonitor-1] INFO c.t.c.c.e.ClientCommunicationEndpoint - Needed to refill connections on client endpoint [id: 0] : [active: 0, max: 1]

                                SimulateTimer.ReSet.run() Tue Apr 26 09:51:38 IST 2016

                                SimulateTimer.Set.run() Tue Apr 26 09:51:40 IST 2016

                                09:51:44.166 [Client-EndpointMonitor-1] INFO c.t.c.c.c.n.NettyClientConnectionFactory - forcing underlying tcp channel closed [is open: false, is active: false]

                                09:51:44.166 [Client-EndpointMonitor-1] ERROR c.t.c.c.e.ClientCommunicationEndpoint - Refilling connections on [endpoint 0, uri: ws://localhost:80/Thingworx/WS] failed : timeout waiting for websocket handshake to complete

                                09:51:44.167 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint reconnection was unsuccessful [name: HvacGateway, id: 0]

                                SimulateTimer.ReSet.run() Tue Apr 26 09:51:48 IST 2016

                                SimulateTimer.Set.run() Tue Apr 26 09:51:52 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:51:58 IST 2016

                                09:51:59.167 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.m.CommunicationEndpointMonitorTask - CommunicationEndpoint Monitor - checking for disconnected endpoints

                                09:51:59.167 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint not connected [name: HvacGateway, id: 0]. Attempting [re]connect...

                                09:51:59.167 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.ClientCommunicationEndpoint - Clearing endpoint authentication data [id: 0]

                                09:51:59.167 [Client-EndpointMonitor-1] INFO c.t.c.c.e.ClientCommunicationEndpoint - Needed to refill connections on client endpoint [id: 0] : [active: 0, max: 1]

                                SimulateTimer.Set.run() Tue Apr 26 09:52:04 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:52:08 IST 2016

                                09:52:09.168 [Client-EndpointMonitor-1] INFO c.t.c.c.c.n.NettyClientConnectionFactory - forcing underlying tcp channel closed [is open: false, is active: false]

                                09:52:09.168 [Client-EndpointMonitor-1] ERROR c.t.c.c.e.ClientCommunicationEndpoint - Refilling connections on [endpoint 0, uri: ws://localhost:80/Thingworx/WS] failed : timeout waiting for websocket handshake to complete

                                09:52:09.168 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint reconnection was unsuccessful [name: HvacGateway, id: 0]

                                SimulateTimer.Set.run() Tue Apr 26 09:52:16 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:52:18 IST 2016

                                09:52:24.168 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.m.CommunicationEndpointMonitorTask - CommunicationEndpoint Monitor - checking for disconnected endpoints

                                09:52:24.168 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint not connected [name: HvacGateway, id: 0]. Attempting [re]connect...

                                09:52:24.168 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.ClientCommunicationEndpoint - Clearing endpoint authentication data [id: 0]

                                09:52:24.168 [Client-EndpointMonitor-1] INFO c.t.c.c.e.ClientCommunicationEndpoint - Needed to refill connections on client endpoint [id: 0] : [active: 0, max: 1]

                                SimulateTimer.Set.run() Tue Apr 26 09:52:28 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:52:28 IST 2016

                                09:52:34.169 [Client-EndpointMonitor-1] INFO c.t.c.c.c.n.NettyClientConnectionFactory - forcing underlying tcp channel closed [is open: false, is active: false]

                                09:52:34.169 [Client-EndpointMonitor-1] ERROR c.t.c.c.e.ClientCommunicationEndpoint - Refilling connections on [endpoint 0, uri: ws://localhost:80/Thingworx/WS] failed : timeout waiting for websocket handshake to complete

                                09:52:34.169 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint reconnection was unsuccessful [name: HvacGateway, id: 0]

                                SimulateTimer.ReSet.run() Tue Apr 26 09:52:38 IST 2016

                                SimulateTimer.Set.run() Tue Apr 26 09:52:40 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:52:48 IST 2016

                                09:52:49.168 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.m.CommunicationEndpointMonitorTask - CommunicationEndpoint Monitor - checking for disconnected endpoints

                                09:52:49.168 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint not connected [name: HvacGateway, id: 0]. Attempting [re]connect...

                                09:52:49.168 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.ClientCommunicationEndpoint - Clearing endpoint authentication data [id: 0]

                                09:52:49.168 [Client-EndpointMonitor-1] INFO c.t.c.c.e.ClientCommunicationEndpoint - Needed to refill connections on client endpoint [id: 0] : [active: 0, max: 1]

                                SimulateTimer.Set.run() Tue Apr 26 09:52:52 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:52:58 IST 2016

                                09:52:59.170 [Client-EndpointMonitor-1] INFO c.t.c.c.c.n.NettyClientConnectionFactory - forcing underlying tcp channel closed [is open: false, is active: false]

                                09:52:59.170 [Client-EndpointMonitor-1] ERROR c.t.c.c.e.ClientCommunicationEndpoint - Refilling connections on [endpoint 0, uri: ws://localhost:80/Thingworx/WS] failed : timeout waiting for websocket handshake to complete

                                09:52:59.170 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint reconnection was unsuccessful [name: HvacGateway, id: 0]

                                SimulateTimer.Set.run() Tue Apr 26 09:53:04 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:53:08 IST 2016

                                09:53:14.169 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.m.CommunicationEndpointMonitorTask - CommunicationEndpoint Monitor - checking for disconnected endpoints

                                09:53:14.169 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint not connected [name: HvacGateway, id: 0]. Attempting [re]connect...

                                09:53:14.169 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.ClientCommunicationEndpoint - Clearing endpoint authentication data [id: 0]

                                09:53:14.169 [Client-EndpointMonitor-1] INFO c.t.c.c.e.ClientCommunicationEndpoint - Needed to refill connections on client endpoint [id: 0] : [active: 0, max: 1]

                                SimulateTimer.Set.run() Tue Apr 26 09:53:16 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:53:18 IST 2016

                                09:53:24.170 [Client-EndpointMonitor-1] INFO c.t.c.c.c.n.NettyClientConnectionFactory - forcing underlying tcp channel closed [is open: false, is active: false]

                                09:53:24.170 [Client-EndpointMonitor-1] ERROR c.t.c.c.e.ClientCommunicationEndpoint - Refilling connections on [endpoint 0, uri: ws://localhost:80/Thingworx/WS] failed : timeout waiting for websocket handshake to complete

                                09:53:24.170 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint reconnection was unsuccessful [name: HvacGateway, id: 0]

                                SimulateTimer.Set.run() Tue Apr 26 09:53:28 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:53:28 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:53:38 IST 2016

                                09:53:39.170 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.m.CommunicationEndpointMonitorTask - CommunicationEndpoint Monitor - checking for disconnected endpoints

                                09:53:39.170 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint not connected [name: HvacGateway, id: 0]. Attempting [re]connect...

                                09:53:39.170 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.ClientCommunicationEndpoint - Clearing endpoint authentication data [id: 0]

                                09:53:39.170 [Client-EndpointMonitor-1] INFO c.t.c.c.e.ClientCommunicationEndpoint - Needed to refill connections on client endpoint [id: 0] : [active: 0, max: 1]

                                SimulateTimer.Set.run() Tue Apr 26 09:53:40 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:53:48 IST 2016

                                09:53:49.171 [Client-EndpointMonitor-1] INFO c.t.c.c.c.n.NettyClientConnectionFactory - forcing underlying tcp channel closed [is open: false, is active: false]

                                09:53:49.171 [Client-EndpointMonitor-1] ERROR c.t.c.c.e.ClientCommunicationEndpoint - Refilling connections on [endpoint 0, uri: ws://localhost:80/Thingworx/WS] failed : timeout waiting for websocket handshake to complete

                                09:53:49.171 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint reconnection was unsuccessful [name: HvacGateway, id: 0]

                                SimulateTimer.Set.run() Tue Apr 26 09:53:52 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:53:58 IST 2016

                                09:54:04.171 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.m.CommunicationEndpointMonitorTask - CommunicationEndpoint Monitor - checking for disconnected endpoints

                                09:54:04.171 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint not connected [name: HvacGateway, id: 0]. Attempting [re]connect...

                                09:54:04.171 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.ClientCommunicationEndpoint - Clearing endpoint authentication data [id: 0]

                                09:54:04.171 [Client-EndpointMonitor-1] INFO c.t.c.c.e.ClientCommunicationEndpoint - Needed to refill connections on client endpoint [id: 0] : [active: 0, max: 1]

                                SimulateTimer.Set.run() Tue Apr 26 09:54:04 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:54:08 IST 2016

                                09:54:14.172 [Client-EndpointMonitor-1] INFO c.t.c.c.c.n.NettyClientConnectionFactory - forcing underlying tcp channel closed [is open: false, is active: false]

                                09:54:14.172 [Client-EndpointMonitor-1] ERROR c.t.c.c.e.ClientCommunicationEndpoint - Refilling connections on [endpoint 0, uri: ws://localhost:80/Thingworx/WS] failed : timeout waiting for websocket handshake to complete

                                09:54:14.172 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint reconnection was unsuccessful [name: HvacGateway, id: 0]

                                SimulateTimer.Set.run() Tue Apr 26 09:54:16 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:54:18 IST 2016

                                SimulateTimer.Set.run() Tue Apr 26 09:54:28 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:54:28 IST 2016

                                09:54:29.172 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.m.CommunicationEndpointMonitorTask - CommunicationEndpoint Monitor - checking for disconnected endpoints

                                09:54:29.172 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint not connected [name: HvacGateway, id: 0]. Attempting [re]connect...

                                09:54:29.172 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.ClientCommunicationEndpoint - Clearing endpoint authentication data [id: 0]

                                09:54:29.172 [Client-EndpointMonitor-1] INFO c.t.c.c.e.ClientCommunicationEndpoint - Needed to refill connections on client endpoint [id: 0] : [active: 0, max: 1]

                                SimulateTimer.ReSet.run() Tue Apr 26 09:54:38 IST 2016

                                09:54:39.175 [Client-EndpointMonitor-1] INFO c.t.c.c.c.n.NettyClientConnectionFactory - forcing underlying tcp channel closed [is open: false, is active: false]

                                09:54:39.175 [Client-EndpointMonitor-1] ERROR c.t.c.c.e.ClientCommunicationEndpoint - Refilling connections on [endpoint 0, uri: ws://localhost:80/Thingworx/WS] failed : timeout waiting for websocket handshake to complete

                                09:54:39.175 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint reconnection was unsuccessful [name: HvacGateway, id: 0]

                                SimulateTimer.Set.run() Tue Apr 26 09:54:40 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:54:48 IST 2016

                                SimulateTimer.Set.run() Tue Apr 26 09:54:52 IST 2016

                                09:54:54.175 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.m.CommunicationEndpointMonitorTask - CommunicationEndpoint Monitor - checking for disconnected endpoints

                                09:54:54.175 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint not connected [name: HvacGateway, id: 0]. Attempting [re]connect...

                                09:54:54.175 [Client-EndpointMonitor-1] DEBUG c.t.c.c.e.ClientCommunicationEndpoint - Clearing endpoint authentication data [id: 0]

                                09:54:54.175 [Client-EndpointMonitor-1] INFO c.t.c.c.e.ClientCommunicationEndpoint - Needed to refill connections on client endpoint [id: 0] : [active: 0, max: 1]

                                SimulateTimer.ReSet.run() Tue Apr 26 09:54:58 IST 2016

                                09:55:04.176 [Client-EndpointMonitor-1] INFO c.t.c.c.c.n.NettyClientConnectionFactory - forcing underlying tcp channel closed [is open: false, is active: false]

                                09:55:04.176 [Client-EndpointMonitor-1] ERROR c.t.c.c.e.ClientCommunicationEndpoint - Refilling connections on [endpoint 0, uri: ws://localhost:80/Thingworx/WS] failed : timeout waiting for websocket handshake to complete

                                09:55:04.176 [Client-EndpointMonitor-1] INFO c.t.c.c.e.m.CommunicationEndpointMonitorTask - Endpoint reconnection was unsuccessful [name: HvacGateway, id: 0]

                                SimulateTimer.Set.run() Tue Apr 26 09:55:04 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:55:08 IST 2016

                                SimulateTimer.Set.run() Tue Apr 26 09:55:16 IST 2016

                                SimulateTimer.ReSet.run() Tue Apr 26 09:55:18 IST 2016

                                  • Re: Error when deploying EMS with Pi temp humidity sensor.
                                    aanjan Heavyweight Champ

                                    Preethi, is this setup to run with SSL? The reason I'm asking is because it seems to timeout waiting for the websocket handshake to complete, and you've pointed it to localhost:80. Is your platform at port 80? Can you try adding a self-signed certificate to your Tomcat and then connecting over wss instead? Here's a quick guide on how to setup SSL on Tomcat.

                                      • Re: Error when deploying EMS with Pi temp humidity sensor.
                                        pnali Explorer
                                        •  

                                          Hi,
                                          I followed the set-up for SSL in tomcat through other website and tried executing code but still the result is same. Can you suggest some solution for this issue.

                                           

                                        • Re: Error when deploying EMS with Pi temp humidity sensor.
                                          pfischer Newbie

                                          Hey,

                                           

                                          my problem seems to be a step further ...

                                           

                                          The connection works but my mashup wont show me the live data...

                                           

                                          there is a single error, when i start the java:

                                           

                                          Here is the standard output of the command:

                                           

                                           

                                          stdout>Temp=22.0*  Humidity=23.0%

                                          Here is the standard error of the command (if any):

                                           

                                           

                                          07:21:15.358 [main] ERROR c.p.tempthing.BaseEdgeServer - Error Processing Scan Request for [WKAThing]

                                          java.lang.NumberFormatException: For input string: "22.0*"

                                                  at sun.misc.FloatingDecimal.readJavaFormatString(FloatingDecimal.java:2043) ~[na:1.8.0_65]

                                                  at sun.misc.FloatingDecimal.parseDouble(FloatingDecimal.java:110) ~[na:1.8.0_65]

                                                  at java.lang.Double.parseDouble(Double.java:538) ~[na:1.8.0_65]

                                                  at com.ptcmanaged.tempthing.TempAndHumidityThing.parseTemperatureFromString(TempAndHumidityThing.java:151) ~[temperature-thing-jar-with-dependencies.jar:na]

                                                  at com.ptcmanaged.tempthing.TempAndHumidityThing.getTemperature(TempAndHumidityThing.java:117) ~[temperature-thing-jar-with-dependencies.jar:na]

                                                  at com.ptcmanaged.tempthing.TempAndHumidityThing.processScanRequest(TempAndHumidityThing.java:100) ~[temperature-thing-jar-with-dependencies.jar:na]

                                                  at com.ptcmanaged.tempthing.BaseEdgeServer.monitorThings(BaseEdgeServer.java:128) ~[temperature-thing-jar-with-dependencies.jar:na]

                                                  at com.ptcmanaged.tempthing.Main.main(Main.java:26) [temperature-thing-jar-with-dependencies.jar:na]

                                          ^C07:21:19.065 [Thread-0] INFO  c.p.tempthing.BaseEdgeServer - Shutting client down...

                                          07:21:19.066 [Thread-0] DEBUG c.t.c.c.e.CommunicationEndpoint - Sending synchronous message, waiting for response [message: BindRequestMessage [requestId: 5, method: UNBINDREQUEST, names: [WKAThing]]]

                                          07:21:19.066 [NettyClient-NIO-1] DEBUG i.n.h.c.h.w.WebSocket08FrameEncoder - Encoding WebSocket Frame opCode=2 length=27

                                          07:21:19.185 [NettyClient-NIO-1] DEBUG i.n.h.c.h.w.WebSocket08FrameDecoder - Decoding WebSocket Frame opCode=2

                                          07:21:19.185 [NettyClient-NIO-1] DEBUG i.n.h.c.h.w.WebSocket08FrameDecoder - Decoding WebSocket Frame length=17

                                          07:21:19.188 [Thread-0] INFO  c.t.communications.client.BaseClient - CommunicationEndpoint Monitor - STOPPING...

                                          07:21:19.188 [NettyClient-NIO-1] DEBUG c.t.c.c.e.DispatchingClientEndpoint - RESPONSE received [endpoint id: 0, duration: 122] ResponseMessage [requestId: 5, endpointId: -1, sessionId: -1, code: STATUS_SUCCESS, multipart: false, packet #: 0, total packets: 0]

                                          07:21:19.188 [Thread-0] INFO  c.t.communications.client.BaseClient - CommunicationEndpoint Monitor - OFF

                                          07:21:19.189 [Thread-0] DEBUG c.t.c.c.e.CommunicationEndpoint - [Endpoint id: 0] closing

                                          07:21:19.189 [Client-EndpointMonitor-1] INFO  c.t.c.c.e.m.CommunicationEndpointMonitorTask - CommunicationEndpoint Monitor was interrupted, system is probably shutting down

                                          07:21:19.190 [Client-EndpointMonitor-1] INFO  c.t.c.c.e.m.CommunicationEndpointMonitorTask - CommunicationEndpoint Monitor - exiting

                                          07:21:19.191 [NettyClient-NIO-1] DEBUG i.n.h.c.h.w.WebSocket08FrameEncoder - Encoding WebSocket Frame opCode=8 length=25

                                          07:21:19.190 [Thread-0] DEBUG c.t.c.c.e.ClientCommunicationEndpoint - Clearing endpoint authentication data [id: 0]

                                          07:21:19.193 [Thread-0] INFO  c.t.c.c.c.n.NettyClientConnectionFactory - NettyClientConnectionFactory - STOPPING

                                          07:21:19.198 [NettyClient-NIO-1] INFO  c.t.c.c.c.n.NettyClientConnection - [websocket id: 0-0] Closing underlying websocket channel

                                          07:21:19.198 [NettyClient-NIO-1] INFO  c.t.c.c.c.n.NettyClientConnection - [websocket id: 0-0] Unregistering NettyClientConnection from ClientEndpoint

                                          07:21:19.198 [NettyClient-NIO-1] DEBUG c.t.c.c.e.CommunicationEndpoint - [Endpoint id: 0, connection id: 0-0] removed Connection

                                          07:21:19.199 [NettyClient-NIO-1] INFO  c.t.c.c.e.CommunicationEndpoint - All Connections are closed [endpoint id: 0]

                                          07:21:19.199 [NettyClient-NIO-1] INFO  c.t.c.client.ConnectedThingClient - Communications Endpoint Closed

                                          07:21:21.406 [Thread-0] INFO  c.t.c.c.c.n.NettyClientConnectionFactory - NettyClientConnectionFactory - OFF

                                          07:21:21.406 [Thread-0] INFO  c.p.tempthing.BaseEdgeServer - Successfully shut down client.

                                           

                                           

                                          can you help me?

                                           

                                          regards, Philipp