- Cisco Community
- Technology and Support
- DevNet
- DevNet Networking
- Crosswork Automation Hub
- NSO Developer Hub Discussions
- EXCEPTION HOOK CALLED - NcsMain DefaultUDPTransportMapping_0.0.0.0/8000
- Subscribe to RSS Feed
- Mark Topic as New
- Mark Topic as Read
- Float this Topic for Current User
- Bookmark
- Subscribe
- Mute
- Printer Friendly Page
EXCEPTION HOOK CALLED - NcsMain DefaultUDPTransportMapping_0.0.0.0/8000
- Mark as New
- Bookmark
- Subscribe
- Mute
- Subscribe to RSS Feed
- Permalink
- Report Inappropriate Content
11-04-2019 12:42 PM - edited 11-04-2019 12:44 PM
Hi, I'm upgrading ncs to nso. Does anyone see below error with nso? I saw it with nso-4.7 and I have snmp-notification-receiver enabled on port 8000 by default. I didn't see this error with same code/configuration with previous ncs-3.4.x release.
Error from JVM:
<INFO> 04-Nov-2019::10:47:51.678 DeleteSlotWorker pool-169-thread-39: - deleting slot 18 from device tree
===== EXCEPTION HOOK CALLED ======
<ERROR> 04-Nov-2019::10:47:52.023 NcsMain DefaultUDPTransportMapping_0.0.0.0/8000: - Received exception from Thread[DefaultUDPTransportMapping_0.0.0.0/8000,5,main]
java.lang.RuntimeException: java.net.SocketException: Socket closed
at org.snmp4j.transport.DefaultUdpTransportMapping$ListenThread.run(DefaultUdpTransportMapping.java:448)
at java.lang.Thread.run(Thread.java:748)
Caused by: java.net.SocketException: Socket closed
at java.net.PlainDatagramSocketImpl.receive0(Native Method)
at java.net.AbstractPlainDatagramSocketImpl.receive(AbstractPlainDatagramSocketImpl.java:143)
at java.net.DatagramSocket.receive(DatagramSocket.java:812)
at org.snmp4j.transport.DefaultUdpTransportMapping$ListenThread.run(DefaultUdpTransportMapping.java:394)
... 1 more
<WARN> 04-Nov-2019::10:47:52.026 NcsMain DefaultUDPTransportMapping_0.0.0.0/8000: - Initializing shutdown
<WARN> 04-Nov-2019::10:47:52.026 NcsMain DefaultUDPTransportMapping_0.0.0.0/8000: - shutdown() called =>
<INFO> 04-Nov-2019::10:47:52.103 AutoDiscUtils pool-169-thread-39: - deleteNodeDiscCdb:: sn 1634019DB
Error from nso developer-log:
<ERR> 4-Nov-2019::10:47:51.672 aurlb02a ncs[453]: devel-snmpa send_notification: unknown variable name tfAlarmStateChangeText
<ERR> 4-Nov-2019::10:47:51.672 aurlb02a ncs[453]: devel-snmpa notification not sent - faulty varbind(s)
<ERR> 4-Nov-2019::10:47:51.714 aurlb02a ncs[453]: devel-snmpa send_notification: unknown variable name tfAlarmStateChangeText
<ERR> 4-Nov-2019::10:47:51.714 aurlb02a ncs[453]: devel-snmpa notification not sent - faulty varbind(s)
<ERR> 4-Nov-2019::10:47:51.772 aurlb02a ncs[453]: devel-snmpa send_notification: unknown variable name tfAlarmStateChangeText
<ERR> 4-Nov-2019::10:47:51.773 aurlb02a ncs[453]: devel-snmpa notification not sent - faulty varbind(s)
<ERR> 4-Nov-2019::10:47:51.822 aurlb02a ncs[453]: devel-snmpa send_notification: unknown variable name tfAlarmStateChangeText
<ERR> 4-Nov-2019::10:47:51.822 aurlb02a ncs[453]: devel-snmpa notification not sent - faulty varbind(s)
<ERR> 4-Nov-2019::10:47:51.868 aurlb02a ncs[453]: devel-snmpa send_notification: unknown variable name tfAlarmStateChangeText
<ERR> 4-Nov-2019::10:47:51.869 aurlb02a ncs[453]: devel-snmpa notification not sent - faulty varbind(s)
<ERR> 4-Nov-2019::10:47:51.917 aurlb02a ncs[453]: devel-snmpa send_notification: unknown variable name tfAlarmStateChangeText
<ERR> 4-Nov-2019::10:47:51.917 aurlb02a ncs[453]: devel-snmpa notification not sent - faulty varbind(s)
- Mark as New
- Bookmark
- Subscribe
- Mute
- Subscribe to RSS Feed
- Permalink
- Report Inappropriate Content
11-06-2019 05:44 PM
I can see same exception error when I use NSO-4.7 original example code for snmp-notification-receiver. It happens when I add or delete a device.
[root@aurlb02a logs]# tail -n 1000 ncs-java-vm.log
Starting java-vm with options:\n' -classpath :/root/nso-4.7/java/jar/* -Dport=4569 -Djava.security.egd=file:/dev/./urandom -Dfile.encoding=UTF-8'
NCS JVM STARTING
JMXURL : service:jmx:rmi://127.0.0.1:9901/jndi/rmi://127.0.0.1:9902/ncs
<DEBUG> 05-Nov-2019::13:45:20,139 NotificationReceiver (snmp-notif-recv:notifRec)-Run-0: -
************************
credentials are:
engineId = 80:00:61:81:80:0c:c4:7a:92:ef:44:b2:61:5c:9b
engineBoots = 2
[user:ncs,Auth:sha,AuthPW:authpass,priv:aes128,PrivPW:privpass]
************************
<DEBUG> 05-Nov-2019::13:45:20,139 NotificationReceiver (snmp-notif-recv:notifRec)-Run-0: -
************************
credentials are:
engineId = 80:00:61:81:80:0c:c4:7a:92:ef:44:b2:61:5c:9b
engineBoots = 2
[user:ncs,Auth:sha,AuthPW:authpass,priv:aes128,PrivPW:privpass]
************************
<DEBUG> 05-Nov-2019::13:45:20,177 Salt (snmp-notif-recv:notifRec)-Run-0: - Initialized Salt to 37b78a6877eb69aa.
<DEBUG> 05-Nov-2019::13:45:20,177 Salt (snmp-notif-recv:notifRec)-Run-0: - Initialized Salt to 37b78a6877eb69aa.
<DEBUG> 05-Nov-2019::13:45:20,180 UsmUserTable (snmp-notif-recv:notifRec)-Run-0: - Adding user ncs = UsmUser[secName=ncs,authProtocol=1.3.6.1.6.3.10.1.1.3,authPassphrase=authpass,privProtocol=1.3.6.1.6.3.10.1.2.4,privPassphrase=privpass,localizationEngineID=null]
<DEBUG> 05-Nov-2019::13:45:20,180 UsmUserTable (snmp-notif-recv:notifRec)-Run-0: - Adding user ncs = UsmUser[secName=ncs,authProtocol=1.3.6.1.6.3.10.1.1.3,authPassphrase=authpass,privProtocol=1.3.6.1.6.3.10.1.2.4,privPassphrase=privpass,localizationEngineID=null]
<DEBUG> 05-Nov-2019::13:45:20,183 DefaultUdpTransportMapping$ListenThread DefaultUDPTransportMapping_0.0.0.0/8000: - UDP receive buffer size for socket 0.0.0.0/8000 is set to: 106496
<DEBUG> 05-Nov-2019::13:45:20,183 DefaultUdpTransportMapping$ListenThread DefaultUDPTransportMapping_0.0.0.0/8000: - UDP receive buffer size for socket 0.0.0.0/8000 is set to: 106496
<DEBUG> 05-Nov-2019::13:48:26,239 DefaultUdpTransportMapping$ListenThread Thread-9: - Terminated worker task: org.snmp4j.transport.DefaultUdpTransportMapping$ListenThread
<DEBUG> 05-Nov-2019::13:48:26,239 DefaultUdpTransportMapping$ListenThread Thread-9: - Terminated worker task: org.snmp4j.transport.DefaultUdpTransportMapping$ListenThread
<DEBUG> 05-Nov-2019::13:48:26,239 DefaultUdpTransportMapping$ListenThread Thread-9: - Interrupting worker task: org.snmp4j.transport.DefaultUdpTransportMapping$ListenThread
<DEBUG> 05-Nov-2019::13:48:26,239 DefaultUdpTransportMapping$ListenThread Thread-9: - Interrupting worker task: org.snmp4j.transport.DefaultUdpTransportMapping$ListenThread
<DEBUG> 05-Nov-2019::13:48:26,240 DefaultUdpTransportMapping$ListenThread Thread-9: - Joining worker task: org.snmp4j.transport.DefaultUdpTransportMapping$ListenThread
<DEBUG> 05-Nov-2019::13:48:26,240 DefaultUdpTransportMapping$ListenThread Thread-9: - Joining worker task: org.snmp4j.transport.DefaultUdpTransportMapping$ListenThread
===== EXCEPTION HOOK CALLED ======
<ERROR> 05-Nov-2019::13:48:26,241 NcsMain DefaultUDPTransportMapping_0.0.0.0/8000: - Received exception from Thread[DefaultUDPTransportMapping_0.0.0.0/8000,5,main]
java.lang.RuntimeException: java.net.SocketException: Socket closed
at org.snmp4j.transport.DefaultUdpTransportMapping$ListenThread.run(DefaultUdpTransportMapping.java:448)
at java.lang.Thread.run(Thread.java:748)
Caused by: java.net.SocketException: Socket closed
at java.net.PlainDatagramSocketImpl.receive0(Native Method)
at java.net.AbstractPlainDatagramSocketImpl.receive(AbstractPlainDatagramSocketImpl.java:143)
at java.net.DatagramSocket.receive(DatagramSocket.java:812)
at org.snmp4j.transport.DefaultUdpTransportMapping$ListenThread.run(DefaultUdpTransportMapping.java:394)
... 1 more
<WARN> 05-Nov-2019::13:48:26,242 NcsMain DefaultUDPTransportMapping_0.0.0.0/8000: - Initializing shutdown
<WARN> 05-Nov-2019::13:48:26,243 NcsMain DefaultUDPTransportMapping_0.0.0.0/8000: - shutdown() called =>
<DEBUG> 05-Nov-2019::13:48:26,333 NotificationReceiver Thread-9: -
************************
credentials are:
engineId = 80:00:61:81:80:0c:c4:7a:92:ef:44:b2:61:5c:9b
engineBoots = 3
[user:ncs,Auth:sha,AuthPW:authpass,priv:aes128,PrivPW:privpass]
************************
<DEBUG> 05-Nov-2019::13:48:26,333 NotificationReceiver Thread-9: -
************************
credentials are:
engineId = 80:00:61:81:80:0c:c4:7a:92:ef:44:b2:61:5c:9b
engineBoots = 3
[user:ncs,Auth:sha,AuthPW:authpass,priv:aes128,PrivPW:privpass]
************************
<DEBUG> 05-Nov-2019::13:48:26,342 UsmUserTable Thread-9: - Cleared UsmUserTable
<DEBUG> 05-Nov-2019::13:48:26,342 UsmUserTable Thread-9: - Cleared UsmUserTable
<DEBUG> 05-Nov-2019::13:48:26,343 UsmUserTable Thread-9: - Adding user ncs = UsmUser[secName=ncs,authProtocol=1.3.6.1.6.3.10.1.1.3,authPassphrase=authpass,privProtocol=1.3.6.1.6.3.10.1.2.4,privPassphrase=privpass,localizationEngineID=null]
<DEBUG> 05-Nov-2019::13:48:26,343 UsmUserTable Thread-9: - Adding user ncs = UsmUser[secName=ncs,authProtocol=1.3.6.1.6.3.10.1.1.3,authPassphrase=authpass,privProtocol=1.3.6.1.6.3.10.1.2.4,privPassphrase=privpass,localizationEngineID=null]
<DEBUG> 05-Nov-2019::13:48:26,343 DefaultUdpTransportMapping$ListenThread DefaultUDPTransportMapping_0.0.0.0/8000: - UDP receive buffer size for socket 0.0.0.0/8000 is set to: 106496
<DEBUG> 05-Nov-2019::13:48:26,343 DefaultUdpTransportMapping$ListenThread DefaultUDPTransportMapping_0.0.0.0/8000: - UDP receive buffer size for socket 0.0.0.0/8000 is set to: 106496
<WARN> 05-Nov-2019::13:48:27,244 NcsMain SHUTDOWN-THREAD: - Stopping by System.exit()
<WARN> 05-Nov-2019::13:48:27,244 NcsMain SHUTDOWN-THREAD: - NCS JVM STOPPED
Starting java-vm with options:\n' -classpath :/root/nso-4.7/java/jar/* -Dport=4569 -Djava.security.egd=file:/dev/./urandom -Dfile.encoding=UTF-8'
NCS JVM STARTING
JMXURL : service:jmx:rmi://127.0.0.1:9901/jndi/rmi://127.0.0.1:9902/ncs
<DEBUG> 05-Nov-2019::13:48:28,274 NotificationReceiver (snmp-notif-recv:notifRec)-Run-0: -
************************
credentials are:
engineId = 80:00:61:81:80:0c:c4:7a:92:ef:44:b2:61:5c:9b
engineBoots = 4
[user:ncs,Auth:sha,AuthPW:authpass,priv:aes128,PrivPW:privpass]
************************
<DEBUG> 05-Nov-2019::13:48:28,274 NotificationReceiver (snmp-notif-recv:notifRec)-Run-0: -
************************
credentials are:
engineId = 80:00:61:81:80:0c:c4:7a:92:ef:44:b2:61:5c:9b
engineBoots = 4
[user:ncs,Auth:sha,AuthPW:authpass,priv:aes128,PrivPW:privpass]
************************
<DEBUG> 05-Nov-2019::13:48:28,310 Salt (snmp-notif-recv:notifRec)-Run-0: - Initialized Salt to cb4bbc9cc3aaa52d.
<DEBUG> 05-Nov-2019::13:48:28,310 Salt (snmp-notif-recv:notifRec)-Run-0: - Initialized Salt to cb4bbc9cc3aaa52d.
<DEBUG> 05-Nov-2019::13:48:28,312 UsmUserTable (snmp-notif-recv:notifRec)-Run-0: - Adding user ncs = UsmUser[secName=ncs,authProtocol=1.3.6.1.6.3.10.1.1.3,authPassphrase=authpass,privProtocol=1.3.6.1.6.3.10.1.2.4,privPassphrase=privpass,localizationEngineID=null]
<DEBUG> 05-Nov-2019::13:48:28,312 UsmUserTable (snmp-notif-recv:notifRec)-Run-0: - Adding user ncs = UsmUser[secName=ncs,authProtocol=1.3.6.1.6.3.10.1.1.3,authPassphrase=authpass,privProtocol=1.3.6.1.6.3.10.1.2.4,privPassphrase=privpass,localizationEngineID=null]
<DEBUG> 05-Nov-2019::13:48:28,315 DefaultUdpTransportMapping$ListenThread DefaultUDPTransportMapping_0.0.0.0/8000: - UDP receive buffer size for socket 0.0.0.0/8000 is set to: 106496
<DEBUG> 05-Nov-2019::13:48:28,315 DefaultUdpTransportMapping$ListenThread DefaultUDPTransportMapping_0.0.0.0/8000: - UDP receive buffer size for socket 0.0.0.0/8000 is set to: 106496
[root@aurlb02a logs]#
Discover and save your favorite ideas. Come back to expert answers, step-by-step guides, recent topics, and more.
New here? Get started with these tips. How to use Community New member guide