Bug 778203 (SOA-708) - InterruptedException on shutdown
Summary: InterruptedException on shutdown
Keywords:
Status: CLOSED WONTFIX
Alias: SOA-708
Product: JBoss Enterprise SOA Platform 4
Classification: JBoss
Component: Standalone Server, Embedded Server
Version: 4.3 IR2,4.3 IR3,4.3 IR4,4.3 IR5
Hardware: Unspecified
OS: Unspecified
high
high
Target Milestone: ---
: CONTINUING
Assignee: Jeff Yu
QA Contact:
URL: http://jira.jboss.org/jira/browse/SOA...
Whiteboard:
Depends On:
Blocks:
TreeView+ depends on / blocked
 
Reported: 2008-08-26 14:06 UTC by Aleksandar Kostadinov
Modified: 2013-07-02 01:34 UTC (History)
1 user (show)

Fixed In Version:
Doc Type: Bug Fix
Doc Text:
Clone Of:
Environment:
Last Closed: 2010-07-28 20:20:34 UTC
Type: Bug


Attachments (Terms of Use)
EAP_server.log.bz2 (60.93 KB, application/x-bzip)
2008-08-27 11:33 UTC, Aleksandar Kostadinov
no flags Details
server.log.zip (10.83 KB, application/zip)
2008-09-03 01:30 UTC, Len DiMaggio
no flags Details
server.log (72.94 KB, text/x-log)
2008-09-29 01:52 UTC, Len DiMaggio
no flags Details
twiddle.txt (58.39 KB, text/plain)
2008-09-29 01:52 UTC, Len DiMaggio
no flags Details
server_42_cp03_cr5_standalone.log.gz (265.28 KB, application/x-gzip)
2008-12-10 13:19 UTC, Len DiMaggio
no flags Details


Links
System ID Private Priority Status Summary Last Updated
Red Hat Bugzilla 778611 0 high CLOSED Add the 'InterruptedException on shutdown' (SOA-708) issue in the Release Note. 2021-02-22 00:41:40 UTC
Red Hat Issue Tracker SOA-708 0 None None None Never

Internal Links: 778611

Description Aleksandar Kostadinov 2008-08-26 14:06:27 UTC
Date of First Response: 2008-08-26 16:34:26
project_key: SOA

I see the following exception on shutdown with either default, all, production servers (using all's log4j configuration). I'm not sure it is necessary for users to see. Probably needs to be changed to DEBUG level if really not relevant.

09:07:59,647 WARN  [NewMsgsWorker] Interrupted waiting for new msg check
java.lang.InterruptedException
	at java.lang.Object.wait(Native Method)
	at java.lang.Object.wait(Object.java:474)
	at EDU.oswego.cs.dl.util.concurrent.Semaphore.acquire(Semaphore.java:108)
	at EDU.oswego.cs.dl.util.concurrent.SemaphoreControlledChannel.take(SemaphoreControlledChannel.java:131)
	at org.jboss.resource.adapter.mail.inflow.NewMsgsWorker.run(NewMsgsWorker.java:75)
	at org.jboss.resource.work.WorkWrapper.execute(WorkWrapper.java:204)
	at org.jboss.util.threadpool.BasicTaskWrapper.run(BasicTaskWrapper.java:275)
	at EDU.oswego.cs.dl.util.concurrent.PooledExecutor$Worker.run(PooledExecutor.java:756)
	at java.lang.Thread.run(Thread.java:595)

Comment 1 Mark Little 2008-08-26 20:34:26 UTC
Please confirm whether or not this is specific to SOA-P by running this on vanilla EAP.

Comment 2 Aleksandar Kostadinov 2008-08-27 11:33:09 UTC
See attached EAP_server.log.bz2 (4.3.GA server all)
No such an exception is thrown by EAP.

Comment 3 Aleksandar Kostadinov 2008-08-27 11:33:09 UTC
Attachment: Added: EAP_server.log.bz2


Comment 4 Mark Little 2008-08-27 13:00:06 UTC
Thanks. Can you attach a full stack trace and indicate what version of OS/JVM you are using?

Comment 5 Aleksandar Kostadinov 2008-08-27 13:13:48 UTC
The full trace you can see in description field. Java version is sun 1.5.0_15
If you need full server logs, please look at http://hudson.qa.jboss.com/hudson/job/soa-win-scripts/217/

Comment 6 Mark Little 2008-08-28 11:48:25 UTC
What version of OS? Did you run any examples before shutting down, or is this the sequence really just 'start up -> shut down'?

Comment 7 Aleksandar Kostadinov 2008-08-29 12:01:04 UTC
No, what I do is start the server, connect RMI ,check services' states and shutdown. The same I tested with EAP.

Comment 8 Mark Little 2008-08-29 17:22:17 UTC
Strange, as I can't get it to fail locally. Can you append a txt file to this JIRA that contains a step-by step command-level sequence, just in case I'm missing something?

Also, what OS are you using (for the 3rd time)?

Comment 9 Len DiMaggio 2008-08-30 01:57:39 UTC
Alex - is this reproducible at will?

I *think* that I saw it once a couple of days ago (on RHEL5) - but I cannot recreate it on RHEL5 now...



Comment 10 Martin Vecera 2008-09-01 07:35:01 UTC
I got it twice on the weekend, once on RHEL5 and once on Ubuntu. I was not able to find out steps to reproduce it. However, it was not my primary concern, so maybe I'll be more lucky today.

Comment 11 Len DiMaggio 2008-09-01 12:52:18 UTC
So - perhaps a timing issue? I still can't get the problem to recur on a RHEL5 system with this CPU - Alex - on which system are you seeing this? single CPU? Dual?

cat /proc/cpuinfo 
processor       : 0
vendor_id       : GenuineIntel
cpu family      : 6
model           : 13
model name      : Intel(R) Pentium(R) M processor 1.70GHz
stepping        : 6
cpu MHz         : 1700.000
cache size      : 2048 KB
fdiv_bug        : no
hlt_bug         : no
f00f_bug        : no
coma_bug        : no
fpu             : yes
fpu_exception   : yes
cpuid level     : 2
wp              : yes
flags           : fpu vme de pse tsc msr mce cx8 mtrr pge mca cmov pat clflush dts acpi mmx fxsr sse sse2 ss tm pbe up est tm2
bogomips        : 3398.33


Comment 12 Martin Vecera 2008-09-01 13:01:03 UTC
I was able to get the problem when there was another AS or ESB instance running in the network. But in this case the user should specify UDP (-u) address or group (-g).

Comment 14 Len DiMaggio 2008-09-03 01:30:10 UTC
Just saw the WARNING message - after starting and stopping the server...

21:24:34,817 INFO  [Server] Shutdown complete
Shutdown complete
Halting VM
21:24:34,820 WARN  [NewMsgsWorker] Interrupted waiting for new msg check
java.lang.InterruptedException
        at java.lang.Object.wait(Native Method)
        at java.lang.Object.wait(Object.java:474)
        at EDU.oswego.cs.dl.util.concurrent.Semaphore.acquire(Semaphore.java:108)
        at EDU.oswego.cs.dl.util.concurrent.SemaphoreControlledChannel.take(SemaphoreControlledChannel.java:131)
        at org.jboss.resource.adapter.mail.inflow.NewMsgsWorker.run(NewMsgsWorker.java:75)
        at org.jboss.resource.work.WorkWrapper.execute(WorkWrapper.java:204)
        at org.jboss.util.threadpool.BasicTaskWrapper.run(BasicTaskWrapper.java:275)
        at EDU.oswego.cs.dl.util.concurrent.PooledExecutor$Worker.run(PooledExecutor.java:756)
        at java.lang.Thread.run(Thread.java:595)


Comment 15 Len DiMaggio 2008-09-03 01:30:10 UTC
Attachment: Added: server.log.zip


Comment 16 Aleksandar Kostadinov 2008-09-03 13:55:03 UTC
I see it on windows soa7 which is dual CPU dual core windows machine. I haven't tried a physical machine with linux (only virtual) so going to build once on such.

Comment 17 Aleksandar Kostadinov 2008-09-03 15:14:18 UTC
I see it on dev17 which is RHEL 4U6 dual Xeon 3,6GHz

Comment 19 Aleksandar Kostadinov 2008-09-03 15:45:52 UTC
Well, in a run I test server all, production and standalone. I got all three of them with the exception.
The only thing I do and you don't is checking services on the server and doing all operations without any delay. 

1.start
2.check services
3. stop

Martin sent recently sent this command "./twiddle.sh -u admin -p admin query '*:*'".

Can you try running it before shutdown?

Comment 20 Aleksandar Kostadinov 2008-09-23 04:26:57 UTC
Link: Added: This issue is related to SOA-815


Comment 21 Aleksandar Kostadinov 2008-09-26 20:30:55 UTC
Issue affects standalone server as well and is still present in IR5.

Comment 22 Aleksandar Kostadinov 2008-09-28 13:35:33 UTC
Link: Removed: This issue is related to SOA-815 


Comment 23 Mark Little 2008-09-28 13:44:07 UTC
Len, can you get more info because we can't reproduce it in engineering?

Comment 24 Aleksandar Kostadinov 2008-09-28 13:50:32 UTC
Could you be more specific what do you need? I can think only of a box where you can reproduce. Or if you tell us where did you tried, I can try as well.

Comment 25 Len DiMaggio 2008-09-29 01:52:10 UTC
Just tried this with IR5.

Saw the problem on (2) of (5) tried just doing a bin/run.sh followed by control/c after the server starts.

The server.log is attached - along with the results of:  ./twiddle.sh -u admin -p admin query '*:*' from just before the server was stopped - but nothing really stands out for me.

This was all on a single CPU-system, running RHRL5.

21:28:51,789 INFO  [TomcatDeployer] undeploy, ctxPath=/invoker, warUrl=.../deploy/http-invoker.sar/invoker.war/
21:28:51,790 INFO  [TomcatDeployer] undeploy, ctxPath=/juddi, warUrl=.../tmp/deploy/tmp22660juddi-exp.war/
21:28:51,793 INFO  [TomcatDeployer] undeploy, ctxPath=/jbossws, warUrl=.../deploy/jbossws.sar/jbossws-context.war/
21:28:51,794 INFO  [TomcatDeployer] undeploy, ctxPath=/juddi, warUrl=.../deploy/juddi-service.sar/juddi.war/
21:28:52,820 INFO  [HypersonicDatabase] Database standalone closed clean
21:28:52,919 WARN  [NewMsgsWorker] Interrupted waiting for new msg check
java.lang.InterruptedException
        at java.lang.Object.wait(Native Method)
        at java.lang.Object.wait(Object.java:474)
        at EDU.oswego.cs.dl.util.concurrent.Semaphore.acquire(Semaphore.java:108)
        at EDU.oswego.cs.dl.util.concurrent.SemaphoreControlledChannel.take(SemaphoreControlledChannel.java:131)
        at org.jboss.resource.adapter.mail.inflow.NewMsgsWorker.run(NewMsgsWorker.java:75)
        at org.jboss.resource.work.WorkWrapper.execute(WorkWrapper.java:204)
        at org.jboss.util.threadpool.BasicTaskWrapper.run(BasicTaskWrapper.java:275)
        at EDU.oswego.cs.dl.util.concurrent.PooledExecutor$Worker.run(PooledExecutor.java:756)
        at java.lang.Thread.run(Thread.java:595)
21:28:54,034 INFO  [TransactionManagerService] Stopping recovery manager
21:28:54,076 INFO  [Server] Shutdown complete
Shutdown complete
Halting VM


Comment 26 Len DiMaggio 2008-09-29 01:52:10 UTC
Attachment: Added: server.log
Attachment: Added: twiddle.txt


Comment 27 Len DiMaggio 2008-09-29 03:20:49 UTC
Alex - just to confirm - with IR5 you're seeing this on a Windows system? Dual processor? What % of the time are you seeing it?

I'm seeing it on RHEL with a 1.2 GHz single CPU system. 

The ONLY steps that I'm performing are run.sh and then (after the server is fully up) control C to stop it. No deployments of .esb archives or anything else. OOTB config used (HSQLDB and H2).




Comment 28 Aleksandar Kostadinov 2008-09-29 04:38:04 UTC
Yes, I see it on windows with 2 dual core CPUs. I've seen it 100% of the builds. As well I see it on linux machines. I don't perform anything than getting list or services and their states.

Comment 29 Jeff Yu 2008-12-10 06:32:09 UTC
Got this error reproduced against SOA-P 4.3.0.GA. Both the standalone and embedded version.

Steps to reproduce the error:

1. start the server, bin/run.sh (for embedded version, I ran bin/run.sh -c default)
2. Open another window, go to the samples/quickstarts/bpm_orchestration2
     ant deploy
     ant deployProcess
     ant startProcess
3. Press 'Ctrl + C' in the server window.

But the interesting thing is that this error didn't happen on jbossesb-server-4.4.GA



Comment 30 Jeff Yu 2008-12-10 06:33:21 UTC
Forgot to say that thanks to Julian. ;-), This error also happens on SOA-P 4.2 CP03 standalone distribution by using the same above steps.



Comment 31 Len DiMaggio 2008-12-10 13:19:07 UTC
Inadvertently attached a 4.3 server.log yesterday - here is a 4.2 CP03 CR5 standalone log.

Comment 32 Len DiMaggio 2008-12-10 13:19:07 UTC
Attachment: Added: server_42_cp03_cr5_standalone.log.gz


Comment 33 Jeff Yu 2008-12-15 07:29:50 UTC
Link: Added: This issue depends JBESB-2232


Comment 34 Kevin Conner 2008-12-16 07:54:49 UTC
Link: Removed: This issue depends JBESB-2232 


Comment 35 Jeff Yu 2008-12-16 08:02:55 UTC
JBoss Forum Reference: Added: http://www.jboss.com/index.html?module=bb&op=viewtopic&t=147063


Comment 36 Jeff Yu 2008-12-17 05:14:24 UTC
Link: Added: This issue is a dependency of JBAS-6326


Comment 37 Jeff Yu 2008-12-17 05:14:59 UTC
Link: Removed: This issue is a dependency of JBAS-6326 


Comment 38 Jeff Yu 2008-12-17 05:15:32 UTC
Link: Added: This issue depends JBAS-6326


Comment 39 Jeff Yu 2008-12-18 07:39:07 UTC
Link: Added: This issue related SOA-1084



Note You need to log in before you can comment on or make changes to this bug.