I was just debugging the jboss trace logs. I am not sure how to measure them but i just saw lot of time going in this activities.
1.
2012-02-17 19:06:57,041 TRACE [org.jboss.util.threadpool.RunnableTaskWrapper] (JBoss System Threads(1)-3) Begin run, wrapper=org.jboss.util.threadpool.RunnableTaskWrapper@493d73f3
2012-02-17 19:06:57,043 TRACE [org.jboss.util.threadpool.RunnableTaskWrapper] (JBoss System Threads(1)-3) End run, wrapper=org.jboss.util.threadpool.RunnableTaskWrapper@493d73f3
2012-02-17 19:06:57,265 TRACE [org.jboss.remoting.transport.socket.SocketServerInvoker] (AcceptorThread[ServerSocket[addr=/0.0.0.0,port=0,localport=3873]]) Thread[AcceptorThread[ServerSocket[addr=/0.0.0.0,port=0,localport=3873]],5,jboss] accepted Socket[addr=/192.168.14.104,port=64630,localport=3873]
2012-02-17 19:06:57,266 TRACE [org.jboss.remoting.transport.socket.SocketServerInvoker] (AcceptorThread[ServerSocket[addr=/0.0.0.0,port=0,localport=3873]]) SocketServerInvoker[rac2:3873] trying to get a worker thread from threadpool for processing
2.
2012-02-17 19:06:57,388 TRACE [org.jboss.remoting.transport.socket.ServerThread] (WorkerThread#0[192.168.14.104:64630]) WorkerThread#0[192.168.14.104:64630] blocking to read version from input stream
2012-02-17 19:06:57,397 TRACE [org.jboss.remoting.transport.socket.ServerThread] (WorkerThread#0[192.168.14.104:64630]) WorkerThread#0[192.168.14.104:64630] read version 22 from input stream
3.
2012-02-17 19:07:16,804 TRACE [org.jboss.remoting.transport.socket.ServerThread] (WorkerThread#0[192.168.14.104:64630]) WorkerThread#0[192.168.14.104:64630] blocking to read version from input stream
2012-02-17 19:07:17,770 TRACE [org.jboss.remoting.transport.socket.ServerThread] (WorkerThread#0[192.168.14.104:64630]) WorkerThread#0[192.168.14.104:64630] read version -1 from input stream