VMware Cloud Community
nickyhaan
Contributor
Contributor
Jump to solution

installing agent on vmware ESX server

Hi, im trying to install the agent 2.7.6 on a vmware esx server 3.01, somehow the agent doesnt want to connect to the management server, i opened up the ports on the esx firewall with the esxcfg-firewall --openport for port 7443 and 2144 but i still cant get the agent to connect to the mgt server .. anything i'm forgetting ?

rgds
Reply
0 Kudos
1 Solution

Accepted Solutions
dougm_hyperic
VMware Employee
VMware Employee
Jump to solution

Hi Nicky,

We'll clear up the port confusion for the next release. As for
availability being yellow, I believe this is due to the combination
of the VMware API in 3.0 being much slower than ESX 2 times the 20
VMs exposes this recently fixed issue: http://jira.hyperic.com/browse/
HHQ-437

You'll find a patch attached to the issue which should fix your
availability lights. Let us know if that helps. It is also possible
to decrease the memory usage by disabling plugins other than vmware
buy adding the following to agent.properties:

plugins.include=vmware

You can also change the max heap size in agent.properties:
agent.javaOpts=-Xmx128m

On Jan 15, 2007, at 3:52 AM, Nicky Haan wrote:

> ok .. this is allready better.. but first of all, autodetect didnt
> work for the settings in hyperic, when trying to put in 0 for port,
> it complains about the port needing to be between 1 and 65535,
> changing the settings on the allready running agent didnt work
> either, so i killed it from the admin machine, and deleted the data
> folder on the agent machine, after reinitializing and putting in
> the right credentials and port 443 (please note that the
> authd.client.port is 902 ..and not 443, check /etc/vmware/config
> for that authd.client.port = "902", so i obviously thought thats
> whats needed in the settings, maybe just state port 443 there ??) i
> then started the inventory, which took quite long (10+ minutes) and
> load and memory was quite up on the esx server (this is a dual quad
> xeon machine with 16 gigs and about 20 vitrual machines running)..
> the agent is now running, but somehow i think its timing out a lot,
> the availability is always on yellow ... i think that the agent
> needs some more tweaking here ... on a esx 3.0 server there is only
> 1 cpu and limited memory available for the linux hostmachine ..
> maybe this is not enough for the agent ?
>



View solution in original post

Reply
0 Kudos
19 Replies
dougm_hyperic
VMware Employee
VMware Employee
Jump to solution

That should be all you need to do. What does log/agent.log say?

On Dec 29, 2006, at 1:48 AM, Nicky Haan wrote:

> Hi, im trying to install the agent 2.7.6 on a vmware esx server
> 3.01, somehow the agent doesnt want to connect to the management
> server, i opened up the ports on the esx firewall with the esxcfg-
> firewall --openport for port 7443 and 2144 but i still cant get the
> agent to connect to the mgt server .. anything i'm forgetting ?
>
> rgds
>



nickyhaan
Contributor
Contributor
Jump to solution

Hi Doug:
[nickyhaan@defle800 agent-2.7.6]$ ./hq-agent.sh start
Starting agent
- Unable to load agent token file. Generating a new one ... Done
- Invoking agent
- Starting agent process
Agent successfully started

[ Running agent setup ]
What is the HQ server IP address: 10.245.64.35
Should Agent communications to HQ always be secure [default=no]: yes
What is the HQ server SSL port [default=7443]:
- Testing secure connection ... Failure
What is the HQ server IP address: Received interrupt while starting. Shutting agent down ...

2007-01-04 15:26:58,959 INFO [AgentCommandsServer] Agent commands loaded
2007-01-04 15:26:59,107 INFO [AgentDaemon] Agent starting up
2007-01-04 15:26:59,209 INFO [ProductPluginManager] Loading plugin: system-plugin.jar
2007-01-04 15:26:59,528 INFO [ProductPluginManager] Loading plugin: netservices-plugin.jar
2007-01-04 15:26:59,620 INFO [MeasurementPlugin] Register TCP Socket proxy for domain: socket
2007-01-04 15:26:59,620 INFO [MeasurementPlugin] Register HTTP proxy for domain: http
2007-01-04 15:26:59,620 INFO [MeasurementPlugin] Register HTTP proxy for domain: url.availability
2007-01-04 15:26:59,621 INFO [MeasurementPlugin] Register FTP proxy for domain: ftp
2007-01-04 15:26:59,626 INFO [ProductPluginManager] Loading plugin: sqlquery-plugin.jar
2007-01-04 15:26:59,731 INFO [SQLQueryMeasurementPlugin] Registered proxy for domain: sql
2007-01-04 15:26:59,731 INFO [ProductPluginManager] Loading plugin: activemq-plugin.xml
2007-01-04 15:26:59,923 INFO [ProductPluginManager] Loading plugin: apache-plugin.jar
2007-01-04 15:27:00,053 INFO [ProductPluginManager] Loading plugin: bind-plugin.jar
2007-01-04 15:27:00,068 INFO [ProductPluginManager] Loading plugin: db2-plugin.jar
2007-01-04 15:27:00,175 INFO [ProductPluginManager] Loading plugin: dotnet-plugin.jar
2007-01-04 15:27:00,196 INFO [ProductPluginManager] Loading plugin: exchange-plugin.jar
2007-01-04 15:27:00,260 INFO [ProductPluginManager] Loading plugin: geronimo-plugin.xml
2007-01-04 15:27:00,282 INFO [ProductPluginManager] Loading plugin: hqagent-plugin.jar
2007-01-04 15:27:00,296 INFO [ProductPluginManager] Loading plugin: iis-plugin.jar
2007-01-04 15:27:00,324 INFO [ProductPluginManager] Loading plugin: iplanet-plugin.jar
2007-01-04 15:27:00,667 INFO [iPlanetMeasurementPlugin] Defaulting to 6.1, loading: webserv61.mib
2007-01-04 15:27:00,714 INFO [ProductPluginManager] Loading plugin: jboss-plugin.jar
2007-01-04 15:27:00,904 INFO [ProductPluginManager] Loading plugin: jmx-plugin.xml
2007-01-04 15:27:00,922 INFO [ProductPluginManager] Loading plugin: memcached-plugin.jar
2007-01-04 15:27:00,933 INFO [ProductPluginManager] Loading plugin: mqseries-plugin.jar
2007-01-04 15:27:00,954 INFO [ProductPluginManager] Loading plugin: mssql-plugin.jar
2007-01-04 15:27:00,971 INFO [ProductPluginManager] Loading plugin: mule-plugin.jar
2007-01-04 15:27:00,992 INFO [ProductPluginManager] Loading plugin: mysql-plugin.jar
2007-01-04 15:27:01,080 INFO [ProductPluginManager] Loading plugin: nagios-plugin.jar
2007-01-04 15:27:01,092 INFO [ProductPluginManager] Loading plugin: netdevice-plugin.jar
2007-01-04 15:27:01,152 INFO [ProductPluginManager] Loading plugin: ntds-plugin.jar
2007-01-04 15:27:01,162 INFO [ProductPluginManager] Loading plugin: ntp-plugin.jar
2007-01-04 15:27:01,171 INFO [ProductPluginManager] Loading plugin: oracle-plugin.jar
2007-01-04 15:27:01,277 INFO [ProductPluginManager] Loading plugin: postfix-plugin.jar
2007-01-04 15:27:01,299 INFO [ProductPluginManager] Loading plugin: postgresql-plugin.jar
2007-01-04 15:27:01,334 INFO [ProductPluginManager] Loading plugin: resin-plugin.xml
2007-01-04 15:27:01,361 INFO [ProductPluginManager] Loading plugin: servlet-plugin.jar
2007-01-04 15:27:01,425 INFO [ProductPluginManager] Loading plugin: sybase-plugin.jar
2007-01-04 15:27:01,446 INFO [ProductPluginManager] Loading plugin: vmware-plugin.jar
2007-01-04 15:27:02,715 INFO [VMwareProductPlugin] Using vmcontrol library=/home/hyperic/agent-2.7.6/./pdk/work/lib/vmware/vmcontrol.so
2007-01-04 15:27:02,731 INFO [ProductPluginManager] Loading plugin: weblogic-plugin.jar
2007-01-04 15:27:02,965 INFO [ProductPluginManager] Loading plugin: websphere-plugin.jar
2007-01-04 15:27:03,055 INFO [AgentDaemon] Product Plugin Manager initalized
2007-01-04 15:27:03,055 INFO [AgentCommandsServer] Agent commands started up
2007-01-04 15:27:03,094 INFO [AutoinventoryCommandsServer] Autoinventory Commands Server started up
2007-01-04 15:27:04,366 WARN [CommandsServer] Agent certificate not found -- generating a new one
2007-01-04 15:27:04,450 INFO [CommandsServer] Commands Server started up
2007-01-04 15:27:04,471 INFO [SenderThread] Maximum metric batch size set to 500
2007-01-04 15:27:04,510 INFO [MeasurementCommandsServer] Measurement Commands Server started up
2007-01-04 15:27:04,525 INFO [VMwareDetector] Unable to get VMware product info
org.hyperic.sigar.vmware.VMwareException: Invalid arguments: Login failed.
at org.hyperic.sigar.vmware.VMwareServer.connect(Native Method)
at org.hyperic.hq.plugin.vmware.VMwareProductInfo.getProductInfo(VMwareProductInfo.java:73)
at org.hyperic.hq.plugin.vmware.VMwareProductInfo.getInfo(VMwareProductInfo.java:58)
at org.hyperic.hq.plugin.vmware.VMwareDetector.getProductInfo(VMwareDetector.java:165)
at org.hyperic.hq.plugin.vmware.VMwareDetector.getLinuxServer(VMwareDetector.java:251)
at org.hyperic.hq.plugin.vmware.VMwareDetector.getServerResources(VMwareDetector.java:145)
at org.hyperic.hq.autoinventory.scanimpl.NullScan.scan(NullScan.java:83)
at org.hyperic.hq.autoinventory.Scanner.start(Scanner.java:196)
at org.hyperic.hq.autoinventory.ScanManager.mainRunLoop(ScanManager.java:141)
at org.hyperic.hq.autoinventory.ScanManager.access$000(ScanManager.java:41)
at org.hyperic.hq.autoinventory.ScanManager$1.run(ScanManager.java:107)
2007-01-04 15:27:04,669 INFO [AgentDaemon] Agent started successfully
2007-01-04 15:27:04,784 INFO [VMwareDetector] Unable to get VMware product info
org.hyperic.sigar.vmware.VMwareException: Invalid arguments: Login failed.
at org.hyperic.sigar.vmware.VMwareServer.connect(Native Method)
at org.hyperic.hq.plugin.vmware.VMwareProductInfo.getProductInfo(VMwareProductInfo.java:73)
at org.hyperic.hq.plugin.vmware.VMwareProductInfo.getInfo(VMwareProductInfo.java:58)
at org.hyperic.hq.plugin.vmware.VMwareDetector.getProductInfo(VMwareDetector.java:165)
at org.hyperic.hq.plugin.vmware.VMwareDetector.getLinuxServer(VMwareDetector.java:251)
at org.hyperic.hq.plugin.vmware.VMwareDetector.getServerResources(VMwareDetector.java:145)
at org.hyperic.hq.autoinventory.scanimpl.NullScan.scan(NullScan.java:83)
at org.hyperic.hq.autoinventory.Scanner.start(Scanner.java:196)
at org.hyperic.hq.autoinventory.ScanManager.mainRunLoop(ScanManager.java:141)
at org.hyperic.hq.autoinventory.ScanManager.access$000(ScanManager.java:41)
at org.hyperic.hq.autoinventory.ScanManager$1.run(ScanManager.java:107)
2007-01-04 15:27:04,809 INFO [VMwareDetector] Unable to get VMware product info
org.hyperic.sigar.vmware.VMwareException: Invalid arguments: Login failed.
at org.hyperic.sigar.vmware.VMwareServer.connect(Native Method)
at org.hyperic.hq.plugin.vmware.VMwareProductInfo.getProductInfo(VMwareProductInfo.java:73)
at org.hyperic.hq.plugin.vmware.VMwareProductInfo.getInfo(VMwareProductInfo.java:58)
at org.hyperic.hq.plugin.vmware.VMwareDetector.getProductInfo(VMwareDetector.java:165)
at org.hyperic.hq.plugin.vmware.VMwareDetector.getLinuxServer(VMwareDetector.java:251)
at org.hyperic.hq.plugin.vmware.VMwareDetector.getServerResources(VMwareDetector.java:145)
at org.hyperic.hq.autoinventory.scanimpl.NullScan.scan(NullScan.java:83)
at org.hyperic.hq.autoinventory.Scanner.start(Scanner.java:196)
at org.hyperic.hq.autoinventory.ScanManager.mainRunLoop(ScanManager.java:141)
at org.hyperic.hq.autoinventory.ScanManager.access$000(ScanManager.java:41)
at org.hyperic.hq.autoinventory.ScanManager$1.run(ScanManager.java:107)
2007-01-04 15:27:04,833 INFO [VMwareDetector] Unable to get VMware product info
org.hyperic.sigar.vmware.VMwareException: Invalid arguments: Login failed.
at org.hyperic.sigar.vmware.VMwareServer.connect(Native Method)
at org.hyperic.hq.plugin.vmware.VMwareProductInfo.getProductInfo(VMwareProductInfo.java:73)
at org.hyperic.hq.plugin.vmware.VMwareProductInfo.getInfo(VMwareProductInfo.java:58)
at org.hyperic.hq.plugin.vmware.VMwareDetector.getProductInfo(VMwareDetector.java:165)
at org.hyperic.hq.plugin.vmware.VMwareDetector.getLinuxServer(VMwareDetector.java:251)
at org.hyperic.hq.plugin.vmware.VMwareDetector.getServerResources(VMwareDetector.java:145)
at org.hyperic.hq.autoinventory.scanimpl.NullScan.scan(NullScan.java:83)
at org.hyperic.hq.autoinventory.Scanner.start(Scanner.java:196)
at org.hyperic.hq.autoinventory.ScanManager.mainRunLoop(ScanManager.java:141)
at org.hyperic.hq.autoinventory.ScanManager.access$000(ScanManager.java:41)
at org.hyperic.hq.autoinventory.ScanManager$1.run(ScanManager.java:107)
2007-01-04 15:27:04,853 ERROR [AutoinventoryCommandsServer] Unable to send autoinventory platform data to server, sleeping for 15 secs before retrying. Error: Unable to commun
icate with server -- provider not yet setup
2007-01-04 15:27:19,853 ERROR [AutoinventoryCommandsServer] Unable to send autoinventory platform data to server, sleeping for 22 secs before retrying. Error: Unable to commun
icate with server -- provider not yet setup
2007-01-04 15:27:23,123 INFO [AgentCommandsServer] Agent commands shut down
2007-01-04 15:27:23,124 INFO [AutoinventoryCommandsServer] Autoinventory Commands Server shutting down
2007-01-04 15:27:23,124 ERROR [AutoinventoryCommandsServer] Unable to send autoinventory platform data to server, sleeping for 22 secs before retrying. Error: Unable to commun
icate with server -- provider not yet setup
2007-01-04 15:27:26,693 INFO [AutoinventoryCommandsServer] Autoinventory Commands Server shut down
2007-01-04 15:27:26,694 INFO [CommandsServer] Commands Server shut down
2007-01-04 15:27:26,694 INFO [MeasurementCommandsServer] Measurement Commands Server shutting down
2007-01-04 15:27:26,694 INFO [SenderThread] Measurement sender interrupted
2007-01-04 15:27:26,694 INFO [MeasurementCommandsServer] Measurement Commands Server shut down
2007-01-04 15:27:26,696 INFO [AgentDaemon] Agent shut down

iptables -L
Chain INPUT (policy DROP)
ACCEPT tcp -- anywhere anywhere tcp dpt:7433
ACCEPT tcp -- anywhere anywhere tcp dpt:2144
ACCEPT udp -- anywhere anywhere udp dpt:2144
ACCEPT udp -- anywhere anywhere udp dpt:7443
Chain OUTPUT (policy DROP)
ACCEPT tcp -- anywhere anywhere tcp dpt:7433
ACCEPT tcp -- anywhere anywhere tcp dpt:2144
ACCEPT udp -- anywhere anywhere udp dpt:2144
ACCEPT udp -- anywhere anywhere udp dpt:7443

so what do you think ?
Reply
0 Kudos
cwitt_hyperic
Hot Shot
Hot Shot
Jump to solution

Two things you will probably want to address:

1. In order for the VMware plugin data collection to work, you will either have to run the agent as root (generally not recommended), or you will need to add the user account you are using to run the agent to the Administrator Role for the ESX server. This permission can be added via the Infrastructure client by selecting the ESX server, and going to the Permissions tab. You may be able to get by with less than the full Administrator complement of permissions, but I've not yet tested where things will cease to work.

2. I've been burned by trying to configure or view the firewall rules with anything but esxcfg-firewall. Looks like you used `iptables -L` to take a look at the current rules. Not saying that is definitely wrong output, but you also may want to see what `esxcfg-firewall --query` says about the current firewall settings. If you are unable to communicate, check the rules for obvious problems, and if nothing glaring pops out, temporarily remove the firewall as a hurdle by stopping it. If you still cannot connect, the firewall is not the issue.

Hopefully this will help us at least get closer to resolution.
nickyhaan
Contributor
Contributor
Jump to solution

ok.. what would help is opening the firewall for port 7443 instead of 7334 .... now atleast the agent starts, it finds virtual machines, but cant capture any date ... it complains:
Unable to get VMware product info: User id does not have permission to read VM config files? in the agant.log
Reply
0 Kudos
nickyhaan
Contributor
Contributor
Jump to solution

2007-01-05 14:46:11,518 INFO [VMwareProductPlugin] Using vmcontrol library=/home/hyperic/agent-2.7.6/./pdk/work/lib/vmware/vmcontrol.so
2007-01-05 14:46:11,531 INFO [ProductPluginManager] Loading plugin: weblogic-plugin.jar
2007-01-05 14:46:11,746 INFO [ProductPluginManager] Loading plugin: websphere-plugin.jar
2007-01-05 14:46:11,820 INFO [AgentDaemon] Product Plugin Manager initalized
2007-01-05 14:46:11,820 INFO [AgentCommandsServer] Agent commands started up
2007-01-05 14:46:11,837 INFO [AutoinventoryCommandsServer] Autoinventory Commands Server started up
2007-01-05 14:46:11,938 INFO [CommandsServer] Commands Server started up
2007-01-05 14:46:12,006 INFO [SenderThread] Maximum metric batch size set to 500
2007-01-05 14:46:12,199 INFO [MeasurementCommandsServer] Measurement Commands Server started up
2007-01-05 14:46:12,205 INFO [ConfigPopulateThread] Starting config populate thread
2007-01-05 14:46:12,450 INFO [AgentDaemon] Agent started successfully
2007-01-05 14:46:13,064 INFO [CollectorThread] CollectorThread started
2007-01-05 14:46:14,775 INFO [AutoinventoryCommandsServer] Autoinventory report successfully sent to server.
2007-01-05 14:46:22,818 INFO [RuntimeAutodiscoverer] Running runtime autodiscovery for VMware ESX 3.x
2007-01-05 14:46:22,858 WARN [RuntimeAutodiscoverer] Error running autodiscoverer for plugin: VMware ESX 3.x: Error discovering VMs: Invalid arguments: Login failed.
org.hyperic.hq.product.PluginException: Error discovering VMs: Invalid arguments: Login failed.
[1]-NESTED-EXCEPTION:
org.hyperic.sigar.vmware.VMwareException: Invalid arguments: Login failed.
at org.hyperic.hq.plugin.vmware.VMwareDetector.getServices(VMwareDetector.java:505)
at org.hyperic.hq.plugin.vmware.VMwareDetector.discoverServices(VMwareDetector.java:391)
at org.hyperic.hq.product.ServerDetector.discoverResources(ServerDetector.java:191)
at org.hyperic.hq.autoinventory.agent.server.RuntimeAutodiscoverer.doRuntimeScan_internal(RuntimeAutodiscoverer.java:292)
at org.hyperic.hq.autoinventory.agent.server.RuntimeAutodiscoverer.doRuntimeScan(RuntimeAutodiscoverer.java:220)
at org.hyperic.hq.autoinventory.ScanManager.mainRunLoop(ScanManager.java:165)
at org.hyperic.hq.autoinventory.ScanManager.access$000(ScanManager.java:41)
at org.hyperic.hq.autoinventory.ScanManager$1.run(ScanManager.java:107)
Caused by: org.hyperic.sigar.vmware.VMwareException: Invalid arguments: Login failed.
at org.hyperic.sigar.vmware.VMwareServer.connect(Native Method)
at org.hyperic.hq.plugin.vmware.VMwareDetector.getServices(VMwareDetector.java:480)
... 7 more
2007-01-05 14:46:22,861 INFO [RuntimeAutodiscoverer] Running runtime autodiscovery for Net Services
2007-01-05 14:46:22,869 INFO [RuntimeAutodiscoverer] Net Services discovery took 0.000
2007-01-05 14:46:22,869 INFO [RuntimeAutodiscoverer] Running runtime autodiscovery for HQ Agent
2007-01-05 14:46:22,876 INFO [RuntimeAutodiscoverer] HQ Agent discovery took 0.000
2007-01-05 14:46:22,876 INFO [RuntimeAutodiscoverer] Running runtime autodiscovery for ProcessServer
2007-01-05 14:46:22,898 INFO [RuntimeAutodiscoverer] ProcessServer discovery took 0.015
2007-01-05 14:46:22,899 INFO [RuntimeAutodiscoverer] Running runtime autodiscovery for NetworkServer
2007-01-05 14:46:22,914 INFO [RuntimeAutodiscoverer] NetworkServer discovery took 0.007
2007-01-05 14:46:22,914 INFO [RuntimeAutodiscoverer] Running runtime autodiscovery for FileServer
2007-01-05 14:46:22,924 INFO [RuntimeAutodiscoverer] FileServer discovery took 0.002
Reply
0 Kudos
cwitt_hyperic
Hot Shot
Hot Shot
Jump to solution

It is in unclear from your post...did you make the permission (VMware Role) changes I recommended? That should provide the necessary permissions on the files in question. If it did not, we certainly need to know about it...and if that is the case, running the HQ agent as root on the ESX box should solve the problem.
Reply
0 Kudos
nickyhaan
Contributor
Contributor
Jump to solution

hi cwitt,

i tried both ..as root and as a deligated user, but give the same error message and no entries in the database ... what i did notice, doing a netstat -an, is that there are lots (>50) connections from highports (around 33000) to localhost 902 where the authdemeam is running. If the firewall is running, they are all in state closed, if the firewall is not running they are in state connected or wait.. but somehow it looks like the agent has problem talking to the auth deamon, since even the vmware console client has problems talking to this deamon, i think the problem is somewhere there in the communication .. i have to apply the "fix" for the problem with connecting the console through NAT, although the monitoring server and the esx server are in the same segment ...

rgds
Reply
0 Kudos
cwitt_hyperic
Hot Shot
Hot Shot
Jump to solution

Did you find a solution to your VMware authd issues?

I do not know if this could be at all related to your issue running the agent, but we discovered through a similar forum thread (http://communities.vmware.com/thread/347097?tstart=0) that permissions granted to your hyperic user for running the agent must be added to the ESX server through a direct connection to the server using the Virtual Infrastructure Client. Assigning permissions to a local account on the ESX box through Virtual Center is not possible, as Virtual Center can work only with the AD/Windows accounts it uses for authentication, not local *nix accounts.
Reply
0 Kudos
nickyhaan
Contributor
Contributor
Jump to solution

No, i dont think it is related, im using the root account for testing the agent at the moment .. that should have enough rights.,..somehow i have the feeling its a combination of the firewall and the way that the agent wants to talk to the local machine .. but even with the firewall off it doenst work as it should .. when i run for over an hour with the firewall on .. i have more then 1000 open sockets from 33000 portrange to port 902 .. without the firewall i dont have so many open sockets but still a lot of errors in the debug log:
[root@*********** log]# cat agent.log
2007-01-12 11:32:00,957 DEBUG [AgentConnection] 127.0.0.1 -> agent:ping
2007-01-12 11:32:02,068 DEBUG [AgentClient] Invoking agent: [/home/hyperic/agent-2.7.6/jre/bin/java, -client, -Dagent.propFile=agent.properties, -Dorg.hyperic.hq.bizapp.agent.CommandsAPIInfo.camUpPort=45925, -Djava.security.auth.login.config=jaas.config, -Xmx128m, -Djava.net.preferIPv4Stack=true, -classpath, ./lib/AgentServer.jar:./lib/lather.jar:./pdk/lib/activation.jar:./pdk/lib/ant.jar:./pdk/lib/bcel-5.1.jar:./pdk/lib/commons-beanutils.jar:./pdk/lib/commons-collections.jar:./pdk/lib/commons-httpclient-2.0.jar:./pdk/lib/commons-logging.jar:./pdk/lib/dnsjava-2.0.1.jar:./pdk/lib/getopt.jar:./pdk/lib/hq-product.jar:./pdk/lib/hyperic-util.jar:./pdk/lib/jakarta-oro-2.0.7.jar:./pdk/lib/jdom_b8.jar:./pdk/lib/jsch-0.1.23.jar:./pdk/lib/junit.jar:./pdk/lib/jxla.jar:./pdk/lib/log4j.jar:./pdk/lib/sigar.jar:./pdk/lib/snmp4j.jar:./pdk/lib/tomcat-jk.jar, org.hyperic.hq.agent.server.AgentDaemon]
2007-01-12 11:32:02,352 INFO [AgentCommandsServer] Agent commands loaded
2007-01-12 11:32:02,412 INFO [AgentDaemon] Agent starting up
2007-01-12 11:32:02,437 DEBUG [ProductPluginManager] Initializing in client mode (pdk=./pdk)
2007-01-12 11:32:02,476 DEBUG [MIBTree] No MIBs in directory: ./pdk/mibs
2007-01-12 11:32:02,481 INFO [ProductPluginManager] Loading plugin: system-plugin.jar
2007-01-12 11:32:02,493 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:02,494 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/system-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:02,696 DEBUG [ProductPluginManager] No classpath configured for: system
2007-01-12 11:32:02,740 INFO [ProductPluginManager] Loading plugin: netservices-plugin.jar
2007-01-12 11:32:02,742 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:02,742 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/netservices-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:02,811 DEBUG [ProductPluginManager] No classpath configured for: netservices
2007-01-12 11:32:02,821 INFO [MeasurementPlugin] Register TCP Socket proxy for domain: socket
2007-01-12 11:32:02,821 INFO [MeasurementPlugin] Register HTTP proxy for domain: http
2007-01-12 11:32:02,821 INFO [MeasurementPlugin] Register HTTP proxy for domain: url.availability
2007-01-12 11:32:02,822 INFO [MeasurementPlugin] Register FTP proxy for domain: ftp
2007-01-12 11:32:02,826 INFO [ProductPluginManager] Loading plugin: sqlquery-plugin.jar
2007-01-12 11:32:02,827 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:02,827 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/sqlquery-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:02,834 DEBUG [ProductPluginManager] adding to sqlquery classpath:
2007-01-12 11:32:02,834 DEBUG [ProductPluginManager] d ./pdk/lib/jdbc
2007-01-12 11:32:02,850 INFO [SQLQueryMeasurementPlugin] Registered proxy for domain: sql
2007-01-12 11:32:02,850 INFO [ProductPluginManager] Loading plugin: activemq-plugin.xml
2007-01-12 11:32:02,855 DEBUG [PluginData] resolveEntity: public=null, systemId=file:/pdk/plugins/process-metrics.xml
2007-01-12 11:32:02,855 DEBUG [PluginData] resolveEntity: pdk/plugins/process-metrics.xml->./pdk/plugins/process-metrics.xml
2007-01-12 11:32:02,869 DEBUG [ProductPluginManager] adding to activemq classpath:
2007-01-12 11:32:02,869 DEBUG [ProductPluginManager] d ./pdk/lib/mx4j
2007-01-12 11:32:02,885 INFO [ProductPluginManager] Loading plugin: apache-plugin.jar
2007-01-12 11:32:02,886 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:02,886 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/apache-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:02,930 DEBUG [ProductPluginManager] adding to apache classpath:
2007-01-12 11:32:02,930 DEBUG [ProductPluginManager] + ./pdk/plugins/netservices-plugin.jar
2007-01-12 11:32:02,989 DEBUG [MIBTree] WWW-MIB added 90 entries
2007-01-12 11:32:02,989 DEBUG [MIBTree] Loading MIB: '/home/hyperic/agent-2.7.6/./pdk/plugins/apache-plugin.jar!mibs/WWW-MIB.txt': success
2007-01-12 11:32:03,008 INFO [ProductPluginManager] Loading plugin: bind-plugin.jar
2007-01-12 11:32:03,013 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:03,013 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/bind-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:03,018 DEBUG [ProductPluginManager] No classpath configured for: bind
2007-01-12 11:32:03,025 INFO [ProductPluginManager] Loading plugin: db2-plugin.jar
2007-01-12 11:32:03,026 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:03,026 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/db2-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:03,045 DEBUG [ClientPluginDeployer] Unchanged file: ./pdk/work/lib/db2/db2monitor.jar
2007-01-12 11:32:03,046 DEBUG [ClientPluginDeployer] Unchanged file: ./pdk/work/lib/db2/javadb2monitor-x86-winnt.dll
2007-01-12 11:32:03,047 DEBUG [ClientPluginDeployer] Unchanged file: ./pdk/work/lib/db2/libjavadb2monitor-amd64-linux.so
2007-01-12 11:32:03,047 DEBUG [ClientPluginDeployer] Unchanged file: ./pdk/work/lib/db2/libjavadb2monitor-pa-hpux-11.sl
2007-01-12 11:32:03,047 DEBUG [ClientPluginDeployer] Unchanged file: ./pdk/work/lib/db2/libjavadb2monitor-x86-linux.so
2007-01-12 11:32:03,048 DEBUG [ProductPluginManager] Adding embedded jars to classpath for: db2=[./pdk/work/lib/db2/db2monitor.jar]
2007-01-12 11:32:03,048 DEBUG [ProductPluginManager] No classpath configured for: db2
2007-01-12 11:32:03,070 DEBUG [DB2MeasurementPlugin] Unable to load db2Monitor: /home/hyperic/agent-2.7.6/pdk/work/lib/db2/libjavadb2monitor-x86-linux.so: libdb2.so.1: cannot open shared object file: No such file or directory
2007-01-12 11:32:03,071 INFO [ProductPluginManager] Loading plugin: dotnet-plugin.jar
2007-01-12 11:32:03,071 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:03,072 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/dotnet-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:03,085 DEBUG [ProductPluginManager] No classpath configured for: dotnet
2007-01-12 11:32:03,090 INFO [ProductPluginManager] Loading plugin: exchange-plugin.jar
2007-01-12 11:32:03,091 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:03,091 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/exchange-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:03,145 DEBUG [ProductPluginManager] No classpath configured for: exchange
2007-01-12 11:32:03,152 INFO [ProductPluginManager] Loading plugin: geronimo-plugin.xml
2007-01-12 11:32:03,161 DEBUG [ProductPluginManager] adding to geronimo classpath:
2007-01-12 11:32:03,161 DEBUG [ProductPluginManager] d ./pdk/lib/mx4j
2007-01-12 11:32:03,161 DEBUG [ProductPluginManager] - repository/org.apache.geronimo.specs/jars/geronimo-j2ee_1.4_spec-*.jar
2007-01-12 11:32:03,161 DEBUG [ProductPluginManager] - repository/geronimo/jars/geronimo-management-*.jar
2007-01-12 11:32:03,169 DEBUG [MxServerControlPlugin] Geronimo 1.0 does not specify any control actions
2007-01-12 11:32:03,169 DEBUG [MxServerControlPlugin] Geronimo 1.0 Linux does not specify any control actions
2007-01-12 11:32:03,172 INFO [ProductPluginManager] Loading plugin: hqagent-plugin.jar
2007-01-12 11:32:03,173 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:03,173 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/hqagent-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:03,183 DEBUG [ProductPluginManager] No classpath configured for: camagent
2007-01-12 11:32:03,187 INFO [ProductPluginManager] Loading plugin: iis-plugin.jar
2007-01-12 11:32:03,188 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:03,188 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/iis-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:03,202 DEBUG [ProductPluginManager] No classpath configured for: iis
2007-01-12 11:32:03,214 INFO [ProductPluginManager] Loading plugin: iplanet-plugin.jar
2007-01-12 11:32:03,215 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:03,215 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/iplanet-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:03,234 DEBUG [ProductPluginManager] No classpath configured for: iplanet
2007-01-12 11:32:03,493 INFO [iPlanetMeasurementPlugin] Defaulting to 6.1, loading: webserv61.mib
2007-01-12 11:32:03,499 DEBUG [MIBTree] IWS-MIB added 93 entries
2007-01-12 11:32:03,499 DEBUG [MIBTree] Loading MIB: '/home/hyperic/agent-2.7.6/./pdk/plugins/iplanet-plugin.jar!mibs/webserv61.mib': success
2007-01-12 11:32:03,539 INFO [ProductPluginManager] Loading plugin: jboss-plugin.jar
2007-01-12 11:32:03,540 DEBUG [PluginData] etc/plugin.properties => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/jboss-plugin.jar!/etc/plugin.properties
2007-01-12 11:32:03,546 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/jboss-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:03,550 DEBUG [PluginData] resolveEntity: public=null, systemId=file:/etc/hibernate-plugin.xml
2007-01-12 11:32:03,550 DEBUG [PluginData] etc/hibernate-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/jboss-plugin.jar!/etc/hibernate-plugin.xml
2007-01-12 11:32:03,552 DEBUG [PluginData] resolveEntity: public=null, systemId=file:/etc/jgroups-plugin.xml
2007-01-12 11:32:03,555 DEBUG [PluginData] etc/jgroups-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/jboss-plugin.jar!/etc/jgroups-plugin.xml
2007-01-12 11:32:03,592 DEBUG [ProductPluginManager] adding to jboss classpath:
2007-01-12 11:32:03,592 DEBUG [ProductPluginManager] - null/client/jnp-client.jar
2007-01-12 11:32:03,592 DEBUG [ProductPluginManager] - null/client/jboss-common-client.jar
2007-01-12 11:32:03,592 DEBUG [ProductPluginManager] - null/client/jboss-jsr77-client.jar
2007-01-12 11:32:03,592 DEBUG [ProductPluginManager] - null/client/jbossall-client.jar
2007-01-12 11:32:03,593 DEBUG [ProductPluginManager] - null/client/log4j.jar
2007-01-12 11:32:03,593 DEBUG [ProductPluginManager] - null/client/jmx-rmi-connector-client.jar
2007-01-12 11:32:03,593 DEBUG [ProductPluginManager] - null/lib/jboss-system.jar
2007-01-12 11:32:03,593 DEBUG [ProductPluginManager] - null/lib/jboss-jmx.jar
2007-01-12 11:32:03,593 DEBUG [ProductPluginManager] - null/lib/jboss-management.jar
2007-01-12 11:32:03,593 DEBUG [ProductPluginManager] - null/lib/dom4j.jar
2007-01-12 11:32:03,593 DEBUG [ProductPluginManager] - null/lib/gnu-regexp.jar
2007-01-12 11:32:03,593 DEBUG [ProductPluginManager] - null/lib/endorsed/xercesImpl.jar
2007-01-12 11:32:03,593 DEBUG [ProductPluginManager] - null/lib/endorsed/xml-apis.jar
2007-01-12 11:32:03,593 DEBUG [ProductPluginManager] - null/server/default/lib/jboss-management.jar
2007-01-12 11:32:03,593 DEBUG [ProductPluginManager] - null/server/all/lib/jboss-management.jar
2007-01-12 11:32:03,593 DEBUG [ProductPluginManager] - null/server/default/lib/jbosssx.jar
2007-01-12 11:32:03,593 DEBUG [ProductPluginManager] - null/server/all/lib/jbosssx.jar
2007-01-12 11:32:03,593 DEBUG [ProductPluginManager] - null/lib/jboss-management.jar
2007-01-12 11:32:03,594 DEBUG [ProductPluginManager] - null/lib/jbosssx.jar
2007-01-12 11:32:03,619 INFO [ProductPluginManager] Loading plugin: jmx-plugin.xml
2007-01-12 11:32:03,625 DEBUG [ProductPluginManager] adding to jmx classpath:
2007-01-12 11:32:03,625 DEBUG [ProductPluginManager] d ./pdk/lib/mx4j
2007-01-12 11:32:03,636 INFO [ProductPluginManager] Loading plugin: memcached-plugin.jar
2007-01-12 11:32:03,637 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:03,637 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/memcached-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:03,645 DEBUG [ProductPluginManager] adding to memcached classpath:
2007-01-12 11:32:03,645 DEBUG [ProductPluginManager] + ./pdk/plugins/netservices-plugin.jar
2007-01-12 11:32:03,648 INFO [ProductPluginManager] Loading plugin: mqseries-plugin.jar
2007-01-12 11:32:03,649 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:03,650 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/mqseries-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:03,655 DEBUG [ClientPluginDeployer] Unchanged file: ./pdk/work/lib/mqseries/com.ibm.mq.pcf.jar
2007-01-12 11:32:03,656 DEBUG [ProductPluginManager] Adding embedded jars to classpath for: mqseries=[./pdk/work/lib/mqseries/com.ibm.mq.pcf.jar]
2007-01-12 11:32:03,656 DEBUG [ProductPluginManager] No classpath configured for: mqseries
2007-01-12 11:32:03,667 INFO [ProductPluginManager] Loading plugin: mssql-plugin.jar
2007-01-12 11:32:03,668 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:03,668 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/mssql-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:03,678 DEBUG [ProductPluginManager] No classpath configured for: mssql
2007-01-12 11:32:03,684 INFO [ProductPluginManager] Loading plugin: mule-plugin.jar
2007-01-12 11:32:03,687 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:03,687 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/mule-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:03,692 DEBUG [ProductPluginManager] adding to mule classpath:
2007-01-12 11:32:03,692 DEBUG [ProductPluginManager] d ./pdk/lib/mx4j
2007-01-12 11:32:03,753 INFO [ProductPluginManager] Loading plugin: mysql-plugin.jar
2007-01-12 11:32:03,754 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:03,754 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/mysql-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:03,770 DEBUG [ProductPluginManager] adding to mysql classpath:
2007-01-12 11:32:03,771 DEBUG [ProductPluginManager] + ./pdk/lib/jdbc/mysql-connector-java-3.0.12-production-bin.jar
2007-01-12 11:32:03,792 INFO [ProductPluginManager] Loading plugin: nagios-plugin.jar
2007-01-12 11:32:03,793 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:03,794 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/nagios-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:03,797 DEBUG [ProductPluginManager] No classpath configured for: nagios
2007-01-12 11:32:03,804 INFO [ProductPluginManager] Loading plugin: netdevice-plugin.jar
2007-01-12 11:32:03,805 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:03,805 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/netdevice-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:03,808 DEBUG [PluginData] resolveEntity: public=null, systemId=file:/etc/netdevice-platform.xml
2007-01-12 11:32:03,808 DEBUG [PluginData] etc/netdevice-platform.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/netdevice-plugin.jar!/etc/netdevice-platform.xml
2007-01-12 11:32:03,809 DEBUG [PluginData] resolveEntity: public=null, systemId=file:/etc/netdevice-services.xml
2007-01-12 11:32:03,809 DEBUG [PluginData] etc/netdevice-services.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/netdevice-plugin.jar!/etc/netdevice-services.xml
2007-01-12 11:32:03,810 DEBUG [PluginData] resolveEntity: public=null, systemId=file:/etc/netdevice-platform.xml
2007-01-12 11:32:03,810 DEBUG [PluginData] etc/netdevice-platform.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/netdevice-plugin.jar!/etc/netdevice-platform.xml
2007-01-12 11:32:03,811 DEBUG [PluginData] resolveEntity: public=null, systemId=file:/etc/netdevice-services.xml
2007-01-12 11:32:03,811 DEBUG [PluginData] etc/netdevice-services.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/netdevice-plugin.jar!/etc/netdevice-services.xml
2007-01-12 11:32:03,813 DEBUG [PluginData] resolveEntity: public=null, systemId=file:/etc/netdevice-platform.xml
2007-01-12 11:32:03,813 DEBUG [PluginData] etc/netdevice-platform.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/netdevice-plugin.jar!/etc/netdevice-platform.xml
2007-01-12 11:32:03,814 DEBUG [PluginData] resolveEntity: public=null, systemId=file:/etc/netdevice-services.xml
2007-01-12 11:32:03,814 DEBUG [PluginData] etc/netdevice-services.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/netdevice-plugin.jar!/etc/netdevice-services.xml
2007-01-12 11:32:03,814 DEBUG [PluginData] resolveEntity: public=null, systemId=file:/etc/netdevice-platform.xml
2007-01-12 11:32:03,814 DEBUG [PluginData] etc/netdevice-platform.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/netdevice-plugin.jar!/etc/netdevice-platform.xml
2007-01-12 11:32:03,815 DEBUG [PluginData] resolveEntity: public=null, systemId=file:/etc/netdevice-services.xml
2007-01-12 11:32:03,815 DEBUG [PluginData] etc/netdevice-services.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/netdevice-plugin.jar!/etc/netdevice-services.xml
2007-01-12 11:32:03,820 DEBUG [ProductPluginManager] No classpath configured for: netdevice
2007-01-12 11:32:03,844 DEBUG [MIBTree] HOST-RESOURCES-MIB added 97 entries
2007-01-12 11:32:03,844 DEBUG [MIBTree] Loading MIB: '/home/hyperic/agent-2.7.6/./pdk/plugins/netdevice-plugin.jar!mibs/HOST-RESOURCES-MIB.txt': success
2007-01-12 11:32:03,852 DEBUG [MIBTree] IF-MIB added 72 entries
2007-01-12 11:32:03,853 DEBUG [MIBTree] Loading MIB: '/home/hyperic/agent-2.7.6/./pdk/plugins/netdevice-plugin.jar!mibs/IF-MIB.txt': success
2007-01-12 11:32:03,856 DEBUG [MIBTree] IP-MIB added 65 entries
2007-01-12 11:32:03,856 DEBUG [MIBTree] Loading MIB: '/home/hyperic/agent-2.7.6/./pdk/plugins/netdevice-plugin.jar!mibs/IP-MIB.txt': success
2007-01-12 11:32:03,859 INFO [ProductPluginManager] Loading plugin: ntds-plugin.jar
2007-01-12 11:32:03,859 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:03,860 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/ntds-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:03,866 DEBUG [ProductPluginManager] No classpath configured for: ntds
2007-01-12 11:32:03,870 INFO [ProductPluginManager] Loading plugin: ntp-plugin.jar
2007-01-12 11:32:03,871 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:03,871 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/ntp-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:03,874 DEBUG [ProductPluginManager] No classpath configured for: ntp
2007-01-12 11:32:03,918 INFO [ProductPluginManager] Loading plugin: oracle-plugin.jar
2007-01-12 11:32:03,919 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:03,920 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/oracle-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:03,929 DEBUG [ProductPluginManager] adding to oracle classpath:
2007-01-12 11:32:03,929 DEBUG [ProductPluginManager] + ./pdk/lib/jdbc/oracle12.jar
2007-01-12 11:32:03,974 INFO [ProductPluginManager] Loading plugin: postfix-plugin.jar
2007-01-12 11:32:03,984 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:03,984 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/postfix-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:03,987 DEBUG [ProductPluginManager] No classpath configured for: postfix
2007-01-12 11:32:03,995 INFO [ProductPluginManager] Loading plugin: postgresql-plugin.jar
2007-01-12 11:32:03,995 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:03,996 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/postgresql-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:04,003 DEBUG [ProductPluginManager] adding to postgresql classpath:
2007-01-12 11:32:04,003 DEBUG [ProductPluginManager] + ./pdk/lib/jdbc/postgresql-7.4.3.jar
2007-01-12 11:32:04,016 DEBUG [ProductPluginManager] process-metrics.xml not a loadable plugin
2007-01-12 11:32:04,016 INFO [ProductPluginManager] Loading plugin: resin-plugin.xml
2007-01-12 11:32:04,021 DEBUG [ProductPluginManager] adding to resin classpath:
2007-01-12 11:32:04,021 DEBUG [ProductPluginManager] d ./pdk/lib/mx4j
2007-01-12 11:32:04,030 INFO [ProductPluginManager] Loading plugin: servlet-plugin.jar
2007-01-12 11:32:04,032 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:04,033 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/servlet-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:04,062 DEBUG [ProductPluginManager] No classpath configured for: servlet
2007-01-12 11:32:04,131 DEBUG [ProductPluginManager] sun-jvm-service.xml not a loadable plugin
2007-01-12 11:32:04,131 INFO [ProductPluginManager] Loading plugin: sybase-plugin.jar
2007-01-12 11:32:04,132 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:04,133 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/sybase-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:04,138 DEBUG [ProductPluginManager] adding to sybase classpath:
2007-01-12 11:32:04,138 DEBUG [ProductPluginManager] + ./pdk/lib/jdbc/sybase-jConnect-5_5-jconn2.jar
2007-01-12 11:32:04,148 INFO [ProductPluginManager] Loading plugin: vmware-plugin.jar
2007-01-12 11:32:04,152 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:04,152 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/vmware-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:04,167 DEBUG [ProductPluginManager] No classpath configured for: vmware
2007-01-12 11:32:04,224 INFO [VMwareProductPlugin] Using vmcontrol library=/home/hyperic/agent-2.7.6/./pdk/work/lib/vmware/vmcontrol.so
2007-01-12 11:32:04,237 INFO [ProductPluginManager] Loading plugin: weblogic-plugin.jar
2007-01-12 11:32:04,238 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:04,241 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/weblogic-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:04,341 DEBUG [ProductPluginManager] No classpath configured for: weblogic
2007-01-12 11:32:04,403 INFO [ProductPluginManager] Loading plugin: websphere-plugin.jar
2007-01-12 11:32:04,404 DEBUG [PluginData] etc/plugin.properties => null
2007-01-12 11:32:04,406 DEBUG [PluginData] etc/hq-plugin.xml => jar:file:/home/hyperic/agent-2.7.6/./pdk/plugins/websphere-plugin.jar!/etc/hq-plugin.xml
2007-01-12 11:32:04,494 DEBUG [WebsphereProductPlugin] websphere.installpath configured using default location
2007-01-12 11:32:04,494 DEBUG [WebsphereProductPlugin] Unable to find soap.client.props
2007-01-12 11:32:04,495 DEBUG [ProductPluginManager] adding to websphere classpath:
2007-01-12 11:32:04,495 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/java/jre/lib/core.jar
2007-01-12 11:32:04,495 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/java/jre/lib/ext/log.jar
2007-01-12 11:32:04,495 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/bootstrap.jar
2007-01-12 11:32:04,495 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/wssec.jar
2007-01-12 11:32:04,495 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/pmiclient.jar
2007-01-12 11:32:04,495 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/wasjmx.jar
2007-01-12 11:32:04,495 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/soap.jar
2007-01-12 11:32:04,495 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/sas.jar
2007-01-12 11:32:04,495 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/pmi.jar
2007-01-12 11:32:04,495 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/wsexception.jar
2007-01-12 11:32:04,495 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/jmxc.jar
2007-01-12 11:32:04,495 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/jmxx.jar
2007-01-12 11:32:04,495 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/jmxext.jar
2007-01-12 11:32:04,496 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/jflt.jar
2007-01-12 11:32:04,496 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/nls.jar
2007-01-12 11:32:04,496 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/ffdc.jar
2007-01-12 11:32:04,496 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/idl.jar
2007-01-12 11:32:04,496 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/java/jre/lib/ext/ibmjsse.jar
2007-01-12 11:32:04,496 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/java/jre/lib/ext/ibmjssefips-ob.jar
2007-01-12 11:32:04,496 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/java/jre/lib/security.jar
2007-01-12 11:32:04,496 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/java/jre/lib/ibmjsseprovider.jar
2007-01-12 11:32:04,496 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/perf.jar
2007-01-12 11:32:04,496 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/websphere.jar
2007-01-12 11:32:04,496 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/ujc.jar
2007-01-12 11:32:04,496 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/ns.jar
2007-01-12 11:32:04,496 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/iwsorb.jar
2007-01-12 11:32:04,496 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/ejbcontainer.jar
2007-01-12 11:32:04,496 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/jts.jar
2007-01-12 11:32:04,496 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/csicpi.jar
2007-01-12 11:32:04,496 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/repository.jar
2007-01-12 11:32:04,497 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/admin.jar
2007-01-12 11:32:04,497 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/xerces.jar
2007-01-12 11:32:04,497 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/j2ee.jar
2007-01-12 11:32:04,497 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/ras.jar
2007-01-12 11:32:04,497 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/utils.jar
2007-01-12 11:32:04,497 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/java/jre/lib/ext/mail.jar
2007-01-12 11:32:04,497 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/management.jar
2007-01-12 11:32:04,497 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/mail-impl.jar
2007-01-12 11:32:04,497 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/emf.jar
2007-01-12 11:32:04,497 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/utils.jar
2007-01-12 11:32:04,497 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/runtime.jar
2007-01-12 11:32:04,497 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/classloader.jar
2007-01-12 11:32:04,497 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/security.jar
2007-01-12 11:32:04,497 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/lib/wasproduct.jar
2007-01-12 11:32:04,497 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/java/jre/lib/ibmcertpathprovider.jar
2007-01-12 11:32:04,497 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/java/jre/lib/ext/ibmjceprovider.jar
2007-01-12 11:32:04,497 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/java/jre/lib/ext/ibmjcefips.jar
2007-01-12 11:32:04,497 DEBUG [ProductPluginManager] - /opt/WebSphere/AppServer/etc/tmx4jTransform.jar
2007-01-12 11:32:04,529 INFO [AgentDaemon] Product Plugin Manager initalized
2007-01-12 11:32:04,529 INFO [AgentCommandsServer] Agent commands started up
2007-01-12 11:32:04,546 INFO [AutoinventoryCommandsServer] Autoinventory Commands Server started up
2007-01-12 11:32:04,551 DEBUG [AutoinventoryCommandsServer] Scheduling DefaultScan...
2007-01-12 11:32:04,566 DEBUG [ResinServerDetector] Loaded etc/hq-server-sigs.properties for: Resin 2.x Linux
2007-01-12 11:32:04,567 DEBUG [ResinServerDetector] Loaded ServerSignature for: Resin 2.x Linux
2007-01-12 11:32:04,567 DEBUG [Tomcat40ServerDetector] Loaded etc/hq-server-sigs.properties for: Tomcat 4.0 Linux
2007-01-12 11:32:04,567 DEBUG [Tomcat40ServerDetector] Loaded ServerSignature for: Tomcat 4.0 Linux
2007-01-12 11:32:04,568 DEBUG [Tomcat41ServerDetector] Loaded etc/hq-server-sigs.properties for: Tomcat 4.1 Linux
2007-01-12 11:32:04,568 DEBUG [Tomcat41ServerDetector] Loaded ServerSignature for: Tomcat 4.1 Linux
2007-01-12 11:32:04,568 DEBUG [Tomcat50ServerDetector] Loaded etc/hq-server-sigs.properties for: Tomcat 5.0 Linux
2007-01-12 11:32:04,569 DEBUG [Tomcat50ServerDetector] Loaded ServerSignature for: Tomcat 5.0 Linux
2007-01-12 11:32:04,569 DEBUG [Tomcat55ServerDetector] Loaded etc/hq-server-sigs.properties for: Tomcat 5.5 Linux
2007-01-12 11:32:04,569 DEBUG [Tomcat55ServerDetector] Loaded ServerSignature for: Tomcat 5.5 Linux
2007-01-12 11:32:04,575 DEBUG [AutoinventoryCommandsServer] auto scan for: [ActiveMQ 4.0, Apache 1.3, Apache 2.0, Apache 2.2, Apache-ERS 2.3, Apache-ERS 2.4, Apache-ERS 3.x, Bind 9.x, FileServer, Geronimo 1.0, HQ Agent, JBoss 3.2, JBoss 4.0, MQSeries 5.x, Mule 1.3, MySQL Process 3.x, MySQL Process 4.x, MySQL Process 5.x, NTP 4.x, Nagios, Net Services, NetworkServer, Oracle 10g, Oracle 8i, Oracle 9i, Postfix 2.x, PostgreSQL 7.4, PostgreSQL 8.0, PostgreSQL 8.1, ProcessServer, Resin 2.x, Resin 3.x, Sun JVM 1.5, Tomcat 4.0, Tomcat 4.1, Tomcat 5.0, Tomcat 5.5, VMware ESX 2.x, VMware ESX 3.x, VMware GSX 3.x, VMware Server 1.x, WebSphere Admin 5.0, WebSphere Admin 6.0, WebSphere Admin 6.1, Weblogic Admin 6.1, Weblogic Admin 7.0, Weblogic Admin 8.1, Weblogic Admin 9.1, Weblogic Admin 9.2, iPlanet Admin 6.0, memcached]
2007-01-12 11:32:04,694 INFO [CommandsServer] Commands Server started up
2007-01-12 11:32:04,706 DEBUG [AutoScan] Running AutoServerDetector for: ActiveMQ 4.0
2007-01-12 11:32:04,729 DEBUG [DiskList] Setting max length for measurement_spool to 104857600 bytes
2007-01-12 11:32:04,730 DEBUG [AutoScan] Running AutoServerDetector for: Apache 1.3
2007-01-12 11:32:04,758 DEBUG [AutoScan] Running AutoServerDetector for: Apache 2.0
2007-01-12 11:32:04,760 DEBUG [AutoScan] Running AutoServerDetector for: Apache 2.2
2007-01-12 11:32:04,761 DEBUG [AutoScan] Running AutoServerDetector for: Apache-ERS 2.3
2007-01-12 11:32:04,764 DEBUG [AutoScan] Running AutoServerDetector for: Apache-ERS 2.4
2007-01-12 11:32:04,768 DEBUG [AutoScan] Running AutoServerDetector for: Apache-ERS 3.x
2007-01-12 11:32:04,772 DEBUG [AutoScan] Running AutoServerDetector for: Bind 9.x
2007-01-12 11:32:04,774 DEBUG [AutoScan] Running AutoServerDetector for: FileServer
2007-01-12 11:32:04,777 DEBUG [AutoScan] Running AutoServerDetector for: Geronimo 1.0
2007-01-12 11:32:04,779 DEBUG [AutoScan] Running AutoServerDetector for: HQ Agent
2007-01-12 11:32:04,780 DEBUG [AutoScan] Running AutoServerDetector for: JBoss 3.2
2007-01-12 11:32:04,780 DEBUG [AutoScan] Running AutoServerDetector for: JBoss 4.0
2007-01-12 11:32:04,780 DEBUG [AutoScan] Running AutoServerDetector for: MQSeries 5.x
2007-01-12 11:32:04,780 DEBUG [AutoScan] Running AutoServerDetector for: Mule 1.3
2007-01-12 11:32:04,781 DEBUG [AutoScan] Running AutoServerDetector for: MySQL Process 3.x
2007-01-12 11:32:04,783 DEBUG [AutoScan] Running AutoServerDetector for: MySQL Process 4.x
2007-01-12 11:32:04,783 DEBUG [AutoScan] Running AutoServerDetector for: MySQL Process 5.x
2007-01-12 11:32:04,783 DEBUG [AutoScan] Running AutoServerDetector for: NTP 4.x
2007-01-12 11:32:04,791 DEBUG [AutoScan] Running AutoServerDetector for: Nagios
2007-01-12 11:32:04,791 DEBUG [AutoScan] Running AutoServerDetector for: Net Services
2007-01-12 11:32:04,792 DEBUG [NetServicesDetector] Created server=*********** Net Services
2007-01-12 11:32:04,792 DEBUG [AutoScan] Running AutoServerDetector for: NetworkServer
2007-01-12 11:32:04,792 DEBUG [AutoScan] Running AutoServerDetector for: Oracle 10g
2007-01-12 11:32:04,793 DEBUG [AutoScan] Running AutoServerDetector for: Oracle 8i
2007-01-12 11:32:04,793 DEBUG [AutoScan] Running AutoServerDetector for: Oracle 9i
2007-01-12 11:32:04,793 DEBUG [AutoScan] Running AutoServerDetector for: Postfix 2.x
2007-01-12 11:32:04,795 DEBUG [AutoScan] Running AutoServerDetector for: PostgreSQL 7.4
2007-01-12 11:32:04,803 INFO [SenderThread] Maximum metric batch size set to 500
2007-01-12 11:32:04,813 DEBUG [AutoScan] Running AutoServerDetector for: PostgreSQL 8.0
2007-01-12 11:32:04,819 DEBUG [AutoScan] Running AutoServerDetector for: PostgreSQL 8.1
2007-01-12 11:32:04,820 DEBUG [AutoScan] Running AutoServerDetector for: ProcessServer
2007-01-12 11:32:04,820 DEBUG [AutoScan] Running AutoServerDetector for: Resin 2.x
2007-01-12 11:32:04,824 DEBUG [DiskList] Setting max length for logtrack_spool to 104857600 bytes
2007-01-12 11:32:04,827 DEBUG [DiskList] Setting max length for measurement_schedule to 104857600 bytes
2007-01-12 11:32:04,827 DEBUG [AutoScan] Running AutoServerDetector for: Resin 3.x
2007-01-12 11:32:04,829 DEBUG [AutoScan] Running AutoServerDetector for: Sun JVM 1.5
2007-01-12 11:32:04,829 DEBUG [AutoScan] Running AutoServerDetector for: Tomcat 4.0
2007-01-12 11:32:04,830 DEBUG [AutoScan] Running AutoServerDetector for: Tomcat 4.1
2007-01-12 11:32:04,830 DEBUG [AutoScan] Running AutoServerDetector for: Tomcat 5.0
2007-01-12 11:32:04,831 DEBUG [AutoScan] Running AutoServerDetector for: Tomcat 5.5
2007-01-12 11:32:04,831 DEBUG [AutoScan] Running AutoServerDetector for: VMware ESX 2.x
2007-01-12 11:32:04,864 DEBUG [DiskList] Setting max length for configtrack_spool to 104857600 bytes
2007-01-12 11:32:04,881 INFO [MeasurementCommandsServer] Measurement Commands Server started up
2007-01-12 11:32:04,885 INFO [ConfigPopulateThread] Starting config populate thread
2007-01-12 11:32:04,985 INFO [AgentDaemon] Agent started successfully
2007-01-12 11:32:04,986 DEBUG [AgentConnection] 127.0.0.1 -> agent:ping
2007-01-12 11:32:04,997 DEBUG [SSLConnectionListener] Handling SSL connection from /127.0.0.1
2007-01-12 11:32:05,245 DEBUG [CommandListener] Dispatching request for 'agent:ping'
2007-01-12 11:32:05,245 DEBUG [CommandListener] Method 'org.hyperic.hq.agent.AgentCommand@1dc64a5' returned an object result
2007-01-12 11:32:05,247 DEBUG [AgentConnection] 127.0.0.1 -> bizapp:getCAMServer
2007-01-12 11:32:05,248 DEBUG [SSLConnectionListener] Handling SSL connection from /127.0.0.1
2007-01-12 11:32:05,381 DEBUG [CommandListener] Dispatching request for 'bizapp:getCAMServer'
2007-01-12 11:32:05,382 DEBUG [CommandListener] Method 'org.hyperic.hq.agent.AgentCommand@101ac93' returned an object result
2007-01-12 11:32:05,836 DEBUG [ScheduleThread] [2:10207:THROUGHPUT] Metric='HQ Agent:camAgent:Monitor=camMetric.schedule:NumMetricsFetched__RATE__=1m' -> None
2007-01-12 11:32:05,836 DEBUG [ScheduleThread] [2:10207:PERFORMANCE] Metric='HQ Agent:camAgent:Monitor=camMetric.sender:TotMetricsSent__RATE__=1m' -> None
2007-01-12 11:32:05,837 DEBUG [ScheduleThread] [2:10207:PERFORMANCE] Metric='HQ Agent:camAgent:Monitor=camMetric.schedule:TotFetchTime' -> 1
2007-01-12 11:32:05,837 DEBUG [ScheduleThread] [2:10207:AVAILABILITY] Metric='HQ Agent:camAgent:availability' -> 1
2007-01-12 11:32:05,838 DEBUG [ScheduleThread] [2:10207:UTILIZATION] Metric='HQ Agent:camAgent:Monitor=agent:JVMFreeMemory' -> 576,616
2007-01-12 11:32:05,838 DEBUG [ScheduleThread] [2:10207:PERFORMANCE] Metric='HQ Agent:camAgent:Monitor=camMetric.sender:TotMetricsSent' -> 0
2007-01-12 11:32:05,838 DEBUG [ScheduleThread] [2:10207:PERFORMANCE] Metric='HQ Agent:camAgent:Monitor=camMetric.schedule:TotFetchTime__RATE__=1m' -> None
2007-01-12 11:32:05,838 DEBUG [ScheduleThread] [2:10207:THROUGHPUT] Metric='HQ Agent:camAgent:Monitor=camMetric.schedule:NumMetricsFetched' -> 8
2007-01-12 11:32:05,838 DEBUG [ScheduleThread] [2:10207:PERFORMANCE] Metric='HQ Agent:camAgent:Monitor=camMetric.sender:ServerOffset' -> 0
2007-01-12 11:32:05,839 DEBUG [ScheduleThread] [2:10207:UTILIZATION] Metric='HQ Agent:camAgent:Monitor=agent:JVMTotalMemory' -> 5,017,600
2007-01-12 11:32:05,848 DEBUG [ScheduleThread] [1:10151:UTILIZATION] Metric='Linux:sigar:Type=Mem:ActualFree' -> 151,601,152
2007-01-12 11:32:05,849 DEBUG [ScheduleThread] [1:10151:UTILIZATION] Metric='Linux:sigar:Type=LoadAverage:1' -> 0.16
2007-01-12 11:32:05,849 DEBUG [ScheduleThread] [1:10151:UTILIZATION] Metric='Linux:sigar:Type=Swap:Used' -> 120,324,096
2007-01-12 11:32:05,850 DEBUG [ScheduleThread] [1:10151:UTILIZATION] Metric='Linux:sigar:Type=Mem:Free' -> 29,917,184
2007-01-12 11:32:05,850 DEBUG [ScheduleThread] [3:11059:THROUGHPUT] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=lo:RxBytes__RATE__=1s' -> None
2007-01-12 11:32:05,851 DEBUG [ScheduleThread] [3:11059:THROUGHPUT] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=lo:RxBytes' -> 291,276,564
2007-01-12 11:32:05,851 DEBUG [ScheduleThread] [3:11059:THROUGHPUT] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=lo:TxBytes' -> 291,276,564
2007-01-12 11:32:05,851 DEBUG [ScheduleThread] [3:11059:UTILIZATION] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=lo:TxPackets__RATE__=1m' -> None
2007-01-12 11:32:05,851 DEBUG [ScheduleThread] [3:11059:UTILIZATION] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=lo:TxPackets' -> 336,676
2007-01-12 11:32:05,851 DEBUG [ScheduleThread] [3:11059:THROUGHPUT] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=lo:TxBytes__RATE__=1s' -> None
2007-01-12 11:32:05,851 DEBUG [ScheduleThread] [3:11059:UTILIZATION] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=lo:RxPackets' -> 336,676
2007-01-12 11:32:05,852 DEBUG [ScheduleThread] [3:11059:AVAILABILITY] Metric='NetworkServer Interface:system.avail:Type=NetIfconfig,Arg=lo:Flags' -> 1
2007-01-12 11:32:05,852 DEBUG [ScheduleThread] [3:11059:UTILIZATION] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=lo:RxPackets__RATE__=1m' -> None
2007-01-12 11:32:05,852 DEBUG [ScheduleThread] [3:11060:UTILIZATION] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vswif0:RxPackets__RATE__=1m' -> None
2007-01-12 11:32:05,852 DEBUG [ScheduleThread] [3:11060:UTILIZATION] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vswif0:RxPackets' -> 338,923,343
2007-01-12 11:32:05,853 DEBUG [ScheduleThread] [3:11060:AVAILABILITY] Metric='NetworkServer Interface:system.avail:Type=NetIfconfig,Arg=vswif0:Flags' -> 1
2007-01-12 11:32:05,853 DEBUG [ScheduleThread] [3:11060:UTILIZATION] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vswif0:TxPackets' -> 477,701,278
2007-01-12 11:32:05,853 DEBUG [ScheduleThread] [3:11060:THROUGHPUT] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vswif0:RxBytes__RATE__=1s' -> None
2007-01-12 11:32:05,853 DEBUG [ScheduleThread] [3:11060:UTILIZATION] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vswif0:TxPackets__RATE__=1m' -> None
2007-01-12 11:32:05,853 DEBUG [ScheduleThread] [3:11060:THROUGHPUT] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vswif0:TxBytes' -> 3,081,145,870
2007-01-12 11:32:05,853 DEBUG [ScheduleThread] [3:11060:THROUGHPUT] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vswif0:RxBytes' -> 150,786,040
2007-01-12 11:32:05,853 DEBUG [ScheduleThread] [3:11060:THROUGHPUT] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vswif0:TxBytes__RATE__=1s' -> None
2007-01-12 11:32:05,853 DEBUG [ScheduleThread] [3:11061:UTILIZATION] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vmnic1:RxPackets' -> 213,015,544
2007-01-12 11:32:05,854 DEBUG [ScheduleThread] [3:11061:UTILIZATION] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vmnic1:RxPackets__RATE__=1m' -> None
2007-01-12 11:32:05,854 DEBUG [ScheduleThread] [3:11061:UTILIZATION] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vmnic1:TxPackets' -> 187,320,173
2007-01-12 11:32:05,854 DEBUG [ScheduleThread] [3:11061:AVAILABILITY] Metric='NetworkServer Interface:system.avail:Type=NetIfconfig,Arg=vmnic1:Flags' -> 1
2007-01-12 11:32:05,854 DEBUG [ScheduleThread] [3:11061:UTILIZATION] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vmnic1:TxPackets__RATE__=1m' -> None
2007-01-12 11:32:05,854 DEBUG [ScheduleThread] [3:11061:THROUGHPUT] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vmnic1:TxBytes' -> 1,327,643,660
2007-01-12 11:32:05,854 DEBUG [ScheduleThread] [3:11061:THROUGHPUT] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vmnic1:TxBytes__RATE__=1s' -> None
2007-01-12 11:32:05,854 DEBUG [ScheduleThread] [3:11061:THROUGHPUT] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vmnic1:RxBytes' -> 198,971,578
2007-01-12 11:32:05,854 DEBUG [ScheduleThread] [3:11061:THROUGHPUT] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vmnic1:RxBytes__RATE__=1s' -> None
2007-01-12 11:32:05,855 DEBUG [ScheduleThread] [3:11062:AVAILABILITY] Metric='NetworkServer Interface:system.avail:Type=NetIfconfig,Arg=vmnic0:Flags' -> 1
2007-01-12 11:32:05,855 DEBUG [ScheduleThread] [3:11062:UTILIZATION] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vmnic0:TxPackets__RATE__=1m' -> None
2007-01-12 11:32:05,856 DEBUG [ScheduleThread] [3:11062:UTILIZATION] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vmnic0:RxPackets' -> 340,562,514
2007-01-12 11:32:05,856 DEBUG [ScheduleThread] [3:11062:THROUGHPUT] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vmnic0:RxBytes' -> 778,641,574
2007-01-12 11:32:05,856 DEBUG [ScheduleThread] [3:11062:UTILIZATION] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vmnic0:TxPackets' -> 477,701,284
2007-01-12 11:32:05,856 DEBUG [ScheduleThread] [3:11062:UTILIZATION] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vmnic0:RxPackets__RATE__=1m' -> None
2007-01-12 11:32:05,856 DEBUG [ScheduleThread] [3:11062:THROUGHPUT] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vmnic0:TxBytes' -> 3,086,088,454
2007-01-12 11:32:05,856 DEBUG [ScheduleThread] [3:11062:THROUGHPUT] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vmnic0:RxBytes__RATE__=1s' -> None
2007-01-12 11:32:05,857 DEBUG [ScheduleThread] [3:11062:THROUGHPUT] Metric='NetworkServer Interface:sigar:Type=NetIfstat,Arg=vmnic0:TxBytes__RATE__=1s' -> None
2007-01-12 11:32:05,857 DEBUG [ScheduleThread] [3:11063:AVAILABILITY] Metric='CPU:system.avail:Type=CpuPercList,Arg=0:Idle' -> 1
2007-01-12 11:32:06,372 DEBUG [ScheduleThread] [3:11063:UTILIZATION] Metric='CPU:sigar:Type=CpuPercList,Arg=0:Sys' -> 0.51
2007-01-12 11:32:06,374 DEBUG [ScheduleThread] [3:11063:UTILIZATION] Metric='CPU:sigar:Type=CpuPercList,Arg=0:Combined' -> 0.627
2007-01-12 11:32:06,375 DEBUG [ScheduleThread] [3:11063:UTILIZATION] Metric='CPU:sigar:Type=CpuPercList,Arg=0:Idle' -> 0.373
2007-01-12 11:32:06,377 DEBUG [ScheduleThread] [3:11063:UTILIZATION] Metric='CPU:sigar:Type=CpuPercList,Arg=0:User' -> 0.118
2007-01-12 11:32:06,400 DEBUG [ScheduleThread] [3:11064:AVAILABILITY] Metric='Process:sigar:Type=ProcState,Arg=Pid.PidFile.eq%3D/var/run/sshd.pid:State' -> 1
2007-01-12 11:32:06,402 DEBUG [ScheduleThread] [3:11064:UTILIZATION] Metric='Process:sigar:Type=ProcCpu,Arg=Pid.PidFile.eq%3D/var/run/sshd.pid:Percent' -> 0
2007-01-12 11:32:06,402 DEBUG [ScheduleThread] [3:11064:UTILIZATION] Metric='Process:sigar:Type=ProcMem,Arg=Pid.PidFile.eq%3D/var/run/sshd.pid:Resident' -> 208,896
2007-01-12 11:32:06,405 DEBUG [ScheduleThread] [3:11065:UTILIZATION] Metric='FileServer Mount:sigar:Type=MountedFileSystemUsage,Arg=/:Free' -> 1,399,656
2007-01-12 11:32:06,405 DEBUG [ScheduleThread] [3:11065:THROUGHPUT] Metric='FileServer Mount:sigar:Type=MountedFileSystemUsage,Arg=/:DiskReads__RATE__=1m' -> None
2007-01-12 11:32:06,405 DEBUG [ScheduleThread] [3:11065:THROUGHPUT] Metric='FileServer Mount:sigar:Type=MountedFileSystemUsage,Arg=/:DiskReads' -> 141,316
2007-01-12 11:32:06,405 DEBUG [ScheduleThread] [3:11065:UTILIZATION] Metric='FileServer Mount:sigar:Type=MountedFileSystemUsage,Arg=/:UsePercent' -> 0.77
2007-01-12 11:32:06,407 DEBUG [ScheduleThread] [3:11065:AVAILABILITY] Metric='FileServer Mount:system.avail:Type=MountedFileSystemUsage,Arg=/:UsePercent' -> 1
2007-01-12 11:32:06,407 DEBUG [ScheduleThread] [3:11065:THROUGHPUT] Metric='FileServer Mount:sigar:Type=MountedFileSystemUsage,Arg=/:DiskWrites' -> 435,717,808
2007-01-12 11:32:06,407 DEBUG [ScheduleThread] [3:11065:THROUGHPUT] Metric='FileServer Mount:sigar:Type=MountedFileSystemUsage,Arg=/:DiskWrites__RATE__=1m' -> None
2007-01-12 11:32:06,408 DEBUG [ScheduleThread] [3:11066:UTILIZATION] Metric='FileServer Mount:sigar:Type=MountedFileSystemUsage,Arg=/boot:UsePercent' -> 0.31
2007-01-12 11:32:06,408 DEBUG [ScheduleThread] [3:11066:THROUGHPUT] Metric='FileServer Mount:sigar:Type=MountedFileSystemUsage,Arg=/boot:DiskWrites' -> 197,690
2007-01-12 11:32:06,408 DEBUG [ScheduleThread] [3:11066:THROUGHPUT] Metric='FileServer Mount:sigar:Type=MountedFileSystemUsage,Arg=/boot:DiskReads' -> 1,375
2007-01-12 11:32:06,408 DEBUG [ScheduleThread] [3:11066:THROUGHPUT] Metric='FileServer Mount:sigar:Type=MountedFileSystemUsage,Arg=/boot:DiskReads__RATE__=1m' -> None
2007-01-12 11:32:06,408 DEBUG [ScheduleThread] [3:11066:THROUGHPUT] Metric='FileServer Mount:sigar:Type=MountedFileSystemUsage,Arg=/boot:DiskWrites__RATE__=1m' -> None
2007-01-12 11:32:06,409 DEBUG [ScheduleThread] [3:11066:AVAILABILITY] Metric='FileServer Mount:system.avail:Type=MountedFileSystemUsage,Arg=/boot:UsePercent' -> 1
2007-01-12 11:32:06,409 DEBUG [ScheduleThread] [3:11066:UTILIZATION] Metric='FileServer Mount:sigar:Type=MountedFileSystemUsage,Arg=/boot:Free' -> 71,771
2007-01-12 11:32:06,409 DEBUG [ScheduleThread] [3:11067:THROUGHPUT] Metric='FileServer Mount:sigar:Type=MountedFileSystemUsage,Arg=/var/log:DiskWrites__RATE__=1m' -> None
2007-01-12 11:32:06,409 DEBUG [ScheduleThread] [3:11067:UTILIZATION] Metric='FileServer Mount:sigar:Type=MountedFileSystemUsage,Arg=/var/log:UsePercent' -> 0.04
2007-01-12 11:32:06,410 DEBUG [ScheduleThread] [3:11067:AVAILABILITY] Metric='FileServer Mount:system.avail:Type=MountedFileSystemUsage,Arg=/var/log:UsePercent' -> 1
2007-01-12 11:32:06,410 DEBUG [ScheduleThread] [3:11067:THROUGHPUT] Metric='FileServer Mount:sigar:Type=MountedFileSystemUsage,Arg=/var/log:DiskReads__RATE__=1m' -> None
2007-01-12 11:32:06,410 DEBUG [ScheduleThread] [3:11067:THROUGHPUT] Metric='FileServer Mount:sigar:Type=MountedFileSystemUsage,Arg=/var/log:DiskReads' -> 1,310
2007-01-12 11:32:06,410 DEBUG [ScheduleThread] [3:11067:UTILIZATION] Metric='FileServer Mount:sigar:Type=MountedFileSystemUsage,Arg=/var/log:Free' -> 1,948,464
2007-01-12 11:32:06,410 DEBUG [ScheduleThread] [3:11067:THROUGHPUT] Metric='FileServer Mount:sigar:Type=MountedFileSystemUsage,Arg=/var/log:DiskWrites' -> 2,206,192
2007-01-12 11:32:06,418 DEBUG [Collector] Adding VMware ESX 3.x collector: {user=root, authd.client.port=902, pass=***********, host=***********}
2007-01-12 11:32:06,420 INFO [CollectorThread] CollectorThread started
2007-01-12 11:32:06,420 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.usedsec__RATE__=1m' -> None
2007-01-12 11:32:06,420 DEBUG [ScheduleThread] [2:10206:AVAILABILITY] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:Availability' -> Future
2007-01-12 11:32:06,420 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.usedsec' -> Future
2007-01-12 11:32:06,420 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.idlesec__RATE__=1m' -> None
2007-01-12 11:32:06,420 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.idlesec' -> Future
2007-01-12 11:32:06,420 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.mem.avail' -> Future
2007-01-12 11:32:06,420 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.mem.size' -> Future
2007-01-12 11:32:06,420 DEBUG [ScheduleThread] Retrying 5 items (MetricValue.FUTUREs)
2007-01-12 11:32:06,421 DEBUG [ScheduleThread] [1:10151:AVAILABILITY] Metric='Linux:system.avail:Type=Platform:Availability' -> 1
2007-01-12 11:32:06,421 DEBUG [ScheduleThread] [2:10206:AVAILABILITY] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:Availability' -> Future
2007-01-12 11:32:06,421 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.usedsec' -> Future
2007-01-12 11:32:06,421 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.idlesec' -> Future
2007-01-12 11:32:06,421 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.mem.avail' -> Future
2007-01-12 11:32:06,421 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.mem.size' -> Future
2007-01-12 11:32:06,421 DEBUG [Collector] Running VMware ESX 3.x collectors
2007-01-12 11:32:07,083 DEBUG [AutoScan] Running AutoServerDetector for: VMware ESX 3.x
2007-01-12 11:32:07,084 DEBUG [AutoScan] Running AutoServerDetector for: VMware GSX 3.x
2007-01-12 11:32:07,084 DEBUG [AutoScan] Running AutoServerDetector for: VMware Server 1.x
2007-01-12 11:32:07,084 DEBUG [AutoScan] Running AutoServerDetector for: WebSphere Admin 5.0
2007-01-12 11:32:07,084 DEBUG [AutoScan] Running AutoServerDetector for: WebSphere Admin 6.0
2007-01-12 11:32:07,084 DEBUG [AutoScan] Running AutoServerDetector for: WebSphere Admin 6.1
2007-01-12 11:32:07,084 DEBUG [AutoScan] Running AutoServerDetector for: Weblogic Admin 6.1
2007-01-12 11:32:07,084 DEBUG [AutoScan] Running AutoServerDetector for: Weblogic Admin 7.0
2007-01-12 11:32:07,085 DEBUG [AutoScan] Running AutoServerDetector for: Weblogic Admin 8.1
2007-01-12 11:32:07,085 DEBUG [AutoScan] Running AutoServerDetector for: Weblogic Admin 9.1
2007-01-12 11:32:07,085 DEBUG [AutoScan] Running AutoServerDetector for: Weblogic Admin 9.2
2007-01-12 11:32:07,085 DEBUG [AutoScan] Running AutoServerDetector for: iPlanet Admin 6.0
2007-01-12 11:32:07,085 DEBUG [AutoScan] Running AutoServerDetector for: memcached
2007-01-12 11:32:07,085 DEBUG [DaemonDetector] Using PROC_QUERY=State.Name.eq=memcached for memcached
2007-01-12 11:32:07,092 DEBUG [DaemonDetector] 'State.Name.eq=memcached' matched 0 processes
2007-01-12 11:32:07,093 DEBUG [AutoinventoryCommandsServer] Sending autoinventory report to server: [ScanState platform={agentToken=null queueStatus=0 customProperties=[B@24de7d productConfig=null controlConfig=null measurementConfig=null diff=0 ignored=false platformTypeName=Linux lastApproved=null certdn=CAM-AGENT-1168262323023-3473344173210086488-6134881030131046535 fqdn=*********** name=null location=null description=VMware 3.0.1 cpuCount=1 id=null mTime=1168597924677 cTime=1168597924677} ips={queueStatus=0 diff=0 ignored=false address=127.0.0.1 mACAddress=00:00:00:00:00:00 netmask=255.0.0.0 id=null mTime=1168597924677 cTime=1168597924677},{queueStatus=0 diff=0 ignored=false address=*********** mACAddress=00:50:56:4D:89:D3 netmask=255.255.255.255 id=null mTime=1168597924677 cTime=1168597924677} serversIncluded=true]
2007-01-12 11:32:07,136 DEBUG [Collector] Fri Jan 12 11:32:07 CET 2007 [Error] (VMware ESX 3.x) Invalid arguments: Login failed. values={Availability=1.0}
2007-01-12 11:32:07,276 INFO [AutoinventoryCommandsServer] Autoinventory report successfully sent to server.
2007-01-12 11:32:10,309 DEBUG [ConfigStorage] Successfully restored config from storage: 2-10202-Net Services-->{platform.id=10151, platform.ip=***********, platform.name=***********, platform.fqdn=***********, installpath=/, platform.type=Linux}
2007-01-12 11:32:10,309 DEBUG [ConfigStorage] Successfully restored config from storage: 2-10203-ProcessServer-->{platform.id=10151, platform.name=***********, platform.ip=***********, platform.fqdn=***********, installpath=/, platform.type=Linux}
2007-01-12 11:32:10,309 DEBUG [ConfigStorage] Successfully restored config from storage: 2-10205-NetworkServer-->{platform.id=10151, platform.name=***********, platform.ip=***********, platform.fqdn=***********, platform.type=Linux, installpath=/}
2007-01-12 11:32:10,310 DEBUG [ConfigStorage] Successfully restored config from storage: 2-10204-FileServer-->{platform.id=10151, platform.ip=***********, platform.name=***********, platform.fqdn=***********, installpath=/, platform.type=Linux}
2007-01-12 11:32:10,310 DEBUG [ConfigStorage] Successfully restored config from storage: 2-10207-HQ Agent-->{platform.id=10151, platform.name=***********, platform.ip=***********, platform.fqdn=***********, installpath=/home/hyperic/agent-2.7.6, platform.type=Linux}
2007-01-12 11:32:10,310 DEBUG [ConfigStorage] Successfully restored config from storage: 2-10206-VMware ESX 3.x-->{platform.id=10151, user=root, platform.ip=***********, platform.name=***********, host=***********, pass=***********, platform.fqdn=***********, installpath=/etc/vmware, authd.client.port=902, platform.type=Linux}
2007-01-12 11:32:15,316 INFO [RuntimeAutodiscoverer] Running runtime autodiscovery for Net Services
2007-01-12 11:32:15,322 DEBUG [NetServicesDetector] no services discovered
2007-01-12 11:32:15,322 INFO [RuntimeAutodiscoverer] Net Services discovery took 0.000
2007-01-12 11:32:15,322 INFO [RuntimeAutodiscoverer] Running runtime autodiscovery for VMware ESX 3.x
2007-01-12 11:32:15,356 WARN [RuntimeAutodiscoverer] Error running autodiscoverer for plugin: VMware ESX 3.x: Error discovering VMs: Invalid arguments: Login failed.
org.hyperic.hq.product.PluginException: Error discovering VMs: Invalid arguments: Login failed.
[1]-NESTED-EXCEPTION:
org.hyperic.sigar.vmware.VMwareException: Invalid arguments: Login failed.
at org.hyperic.hq.plugin.vmware.VMwareDetector.getServices(VMwareDetector.java:505)
at org.hyperic.hq.plugin.vmware.VMwareDetector.discoverServices(VMwareDetector.java:391)
at org.hyperic.hq.product.ServerDetector.discoverResources(ServerDetector.java:191)
at org.hyperic.hq.autoinventory.agent.server.RuntimeAutodiscoverer.doRuntimeScan_internal(RuntimeAutodiscoverer.java:292)
at org.hyperic.hq.autoinventory.agent.server.RuntimeAutodiscoverer.doRuntimeScan(RuntimeAutodiscoverer.java:220)
at org.hyperic.hq.autoinventory.ScanManager.mainRunLoop(ScanManager.java:165)
at org.hyperic.hq.autoinventory.ScanManager.access$000(ScanManager.java:41)
at org.hyperic.hq.autoinventory.ScanManager$1.run(ScanManager.java:107)
Caused by: org.hyperic.sigar.vmware.VMwareException: Invalid arguments: Login failed.
at org.hyperic.sigar.vmware.VMwareServer.connect(Native Method)
at org.hyperic.hq.plugin.vmware.VMwareDetector.getServices(VMwareDetector.java:480)
... 7 more
2007-01-12 11:32:15,358 INFO [RuntimeAutodiscoverer] Running runtime autodiscovery for HQ Agent
2007-01-12 11:32:15,363 DEBUG [AgentServerDetector] no services discovered
2007-01-12 11:32:15,364 INFO [RuntimeAutodiscoverer] HQ Agent discovery took 0.000
2007-01-12 11:32:15,364 INFO [RuntimeAutodiscoverer] Running runtime autodiscovery for NetworkServer
2007-01-12 11:32:15,456 DEBUG [SystemServerDetector] discovered *********** Linux Network Interface lo (loopback) [NetworkServer Interface]
2007-01-12 11:32:15,458 DEBUG [SystemServerDetector] discovered *********** Linux Network Interface vswif0 (ethernet) [NetworkServer Interface]
2007-01-12 11:32:15,458 DEBUG [SystemServerDetector] discovered *********** Linux Network Interface vmnic1 (ethernet) [NetworkServer Interface]
2007-01-12 11:32:15,459 DEBUG [SystemServerDetector] discovered *********** Linux Network Interface vmnic0 (ethernet) [NetworkServer Interface]
2007-01-12 11:32:15,461 INFO [RuntimeAutodiscoverer] NetworkServer discovery took 0.093
2007-01-12 11:32:15,461 INFO [RuntimeAutodiscoverer] Running runtime autodiscovery for ProcessServer
2007-01-12 11:32:15,467 DEBUG [SystemServerDetector] discovered *********** Linux CPU 1 (1862Mhz Intel Xeon) [CPU]
2007-01-12 11:32:15,468 DEBUG [SystemServerDetector] discovered *********** Linux sshd Process [Process]
2007-01-12 11:32:15,471 DEBUG [AutoinventoryPluginManager] Get service configs Process=null
2007-01-12 11:32:15,471 DEBUG [SystemServerDetector] User AI is disabled=null
2007-01-12 11:32:15,471 INFO [RuntimeAutodiscoverer] ProcessServer discovery took 0.004
2007-01-12 11:32:15,471 INFO [RuntimeAutodiscoverer] Running runtime autodiscovery for FileServer
2007-01-12 11:32:15,476 DEBUG [SystemServerDetector] discovered *********** Linux File System /dev/sda2 mounted on / (local/ext3) [FileServer Mount]
2007-01-12 11:32:15,476 DEBUG [SystemServerDetector] discovered *********** Linux File System /dev/sda1 mounted on /boot (local/ext3) [FileServer Mount]
2007-01-12 11:32:15,476 DEBUG [SystemServerDetector] discovered *********** Linux File System /dev/sda6 mounted on /var/log (local/ext3) [FileServer Mount]
2007-01-12 11:32:15,477 DEBUG [AutoinventoryPluginManager] Get service configs FileServer File=null
2007-01-12 11:32:15,477 DEBUG [AutoinventoryPluginManager] Get service configs FileServer Directory=null
2007-01-12 11:32:15,477 DEBUG [AutoinventoryPluginManager] Get service configs Script=null
2007-01-12 11:32:15,477 INFO [RuntimeAutodiscoverer] FileServer discovery took 0.002
2007-01-12 11:32:15,477 DEBUG [RuntimeAutodiscoverer] Sending RuntimeReport: [CompositeRRR
Report #0 from reporting server=10205:
Platform #0 ID=null FQDN=***********
Server #0 ID=10205 Name=*********** Linux NetworkServer Stype=NetworkServer serviceCount=4
Report #1 from reporting server=10203:
Platform #0 ID=null FQDN=***********
Server #0 ID=10203 Name=*********** Linux ProcessServer Stype=ProcessServer serviceCount=2
Report #2 from reporting server=10204:
Platform #0 ID=null FQDN=***********
Server #0 ID=10204 Name=*********** Linux FileServer Stype=FileServer serviceCount=3
]
2007-01-12 11:33:00,003 DEBUG [ScheduleThread] Retrying 5 items (MetricValue.FUTUREs)
2007-01-12 11:33:00,004 DEBUG [ScheduleThread] [1:10151:AVAILABILITY] Metric='Linux:system.avail:Type=Platform:Availability' -> 1
2007-01-12 11:33:00,004 DEBUG [ScheduleThread] [2:10206:AVAILABILITY] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:Availability' -> 1
2007-01-12 11:33:00,004 DEBUG [CollectorResult] Attribute 'system.cpu.usedsec' not found
2007-01-12 11:33:00,004 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.usedsec' -> None
2007-01-12 11:33:00,004 DEBUG [CollectorResult] Attribute 'system.cpu.idlesec' not found
2007-01-12 11:33:00,004 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.idlesec' -> None
2007-01-12 11:33:00,004 DEBUG [CollectorResult] Attribute 'system.mem.avail' not found
2007-01-12 11:33:00,004 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.mem.avail' -> None
2007-01-12 11:33:00,004 DEBUG [CollectorResult] Attribute 'system.mem.size' not found
2007-01-12 11:33:00,004 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.mem.size' -> None
2007-01-12 11:33:01,814 DEBUG [SSLConnectionListener] Handling SSL connection from /10.245.64.35
2007-01-12 11:33:02,045 DEBUG [CommandListener] Dispatching request for 'rtm:getMeasurements'
2007-01-12 11:33:02,047 DEBUG [MeasurementCommandsServer] Getting real time measurement: VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:Availability
2007-01-12 11:33:02,047 DEBUG [MeasurementCommandsServer] Result was: 1
2007-01-12 11:33:02,047 DEBUG [MeasurementCommandsServer] Getting real time measurement: VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.idlesec
2007-01-12 11:33:02,047 DEBUG [CollectorResult] Attribute 'system.cpu.idlesec' not found
2007-01-12 11:33:02,048 DEBUG [MeasurementCommandsServer] Result was: None
2007-01-12 11:33:02,048 DEBUG [MeasurementCommandsServer] Getting real time measurement: VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.idlesec__RATE__=1m
2007-01-12 11:33:02,048 DEBUG [CollectorResult] Attribute 'system.cpu.idlesec' not found
2007-01-12 11:33:02,049 DEBUG [MeasurementCommandsServer] Result was: None
2007-01-12 11:33:02,049 DEBUG [MeasurementCommandsServer] Getting real time measurement: VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.usedsec
2007-01-12 11:33:02,049 DEBUG [CollectorResult] Attribute 'system.cpu.usedsec' not found
2007-01-12 11:33:02,049 DEBUG [MeasurementCommandsServer] Result was: None
2007-01-12 11:33:02,049 DEBUG [CommandListener] Method 'org.hyperic.hq.agent.AgentCommand@1c20eb7' returned an object result
2007-01-12 11:33:02,133 DEBUG [SSLConnectionListener] Handling SSL connection from /10.245.64.35
2007-01-12 11:33:02,364 DEBUG [CommandListener] Dispatching request for 'track:trackRemove'
2007-01-12 11:33:02,367 DEBUG [CommandListener] Method 'org.hyperic.hq.agent.AgentCommand@3a835d' returned an object result
2007-01-12 11:33:02,368 DEBUG [SSLConnectionListener] Handling SSL connection from /10.245.64.35
2007-01-12 11:33:02,556 DEBUG [CommandListener] Dispatching request for 'rtm:scheduleMeasurements'
2007-01-12 11:33:02,559 DEBUG [MeasurementCommandsServer] Scheduling 7 metrics for 2:10206: new SRN = 165
2007-01-12 11:33:02,559 DEBUG [ScheduleThread] Unscheduling metrics for 2:10206: [80, 81, 82, 83, 84, 85, 86]
2007-01-12 11:33:02,567 DEBUG [CollectorResult] Attribute 'system.mem.size' not found
2007-01-12 11:33:02,567 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.mem.size' -> None
2007-01-12 11:33:02,567 DEBUG [CollectorResult] Attribute 'system.cpu.usedsec' not found
2007-01-12 11:33:02,567 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.usedsec' -> None
2007-01-12 11:33:02,568 DEBUG [MeasurementSchedule] Adding new SRN for entity 2:10206: Initial value = 165
2007-01-12 11:33:02,568 DEBUG [CommandListener] Method 'org.hyperic.hq.agent.AgentCommand@cfe049' returned an object result
2007-01-12 11:33:02,569 DEBUG [SSLConnectionListener] Handling SSL connection from /10.245.64.35
2007-01-12 11:33:02,581 DEBUG [ScheduleThread] [2:10206:AVAILABILITY] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:Availability' -> 1
2007-01-12 11:33:02,581 DEBUG [CollectorResult] Attribute 'system.cpu.usedsec' not found
2007-01-12 11:33:02,581 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.usedsec__RATE__=1m' -> None
2007-01-12 11:33:02,581 DEBUG [CollectorResult] Attribute 'system.cpu.idlesec' not found
2007-01-12 11:33:02,581 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.idlesec' -> None
2007-01-12 11:33:02,581 DEBUG [CollectorResult] Attribute 'system.mem.avail' not found
2007-01-12 11:33:02,581 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.mem.avail' -> None
2007-01-12 11:33:02,581 DEBUG [CollectorResult] Attribute 'system.cpu.idlesec' not found
2007-01-12 11:33:02,581 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.idlesec__RATE__=1m' -> None
2007-01-12 11:33:02,804 DEBUG [CommandListener] Dispatching request for 'track:trackRemove'
2007-01-12 11:33:02,804 DEBUG [CommandListener] Method 'org.hyperic.hq.agent.AgentCommand@1642bd6' returned an object result
2007-01-12 11:33:02,805 DEBUG [SSLConnectionListener] Handling SSL connection from /10.245.64.35
2007-01-12 11:33:02,995 DEBUG [CommandListener] Dispatching request for 'rtm:scheduleMeasurements'
2007-01-12 11:33:02,995 DEBUG [MeasurementCommandsServer] Scheduling 7 metrics for 2:10206: new SRN = 166
2007-01-12 11:33:02,995 DEBUG [ScheduleThread] Unscheduling metrics for 2:10206: [87, 88, 89, 90, 91, 92, 93]
2007-01-12 11:33:03,001 DEBUG [MeasurementSchedule] Adding new SRN for entity 2:10206: Initial value = 166
2007-01-12 11:33:03,001 DEBUG [CommandListener] Method 'org.hyperic.hq.agent.AgentCommand@6f8b2b' returned an object result
2007-01-12 11:33:03,001 DEBUG [SSLConnectionListener] Handling SSL connection from /10.245.64.35
2007-01-12 11:33:03,003 DEBUG [CollectorResult] Attribute 'system.mem.size' not found
2007-01-12 11:33:03,003 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.mem.size' -> None
2007-01-12 11:33:03,003 DEBUG [CollectorResult] Attribute 'system.cpu.idlesec' not found
2007-01-12 11:33:03,003 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.idlesec__RATE__=1m' -> None
2007-01-12 11:33:03,003 DEBUG [CollectorResult] Attribute 'system.mem.avail' not found
2007-01-12 11:33:03,003 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.mem.avail' -> None
2007-01-12 11:33:03,003 DEBUG [CollectorResult] Attribute 'system.cpu.usedsec' not found
2007-01-12 11:33:03,004 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.usedsec' -> None
2007-01-12 11:33:03,004 DEBUG [ScheduleThread] [2:10206:AVAILABILITY] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:Availability' -> 1
2007-01-12 11:33:03,004 DEBUG [CollectorResult] Attribute 'system.cpu.usedsec' not found
2007-01-12 11:33:03,004 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.usedsec__RATE__=1m' -> None
2007-01-12 11:33:03,004 DEBUG [CollectorResult] Attribute 'system.cpu.idlesec' not found
2007-01-12 11:33:03,004 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.idlesec' -> None
2007-01-12 11:33:03,245 DEBUG [CommandListener] Dispatching request for 'autoinv:pushRuntimeDiscoveryConfig'
2007-01-12 11:33:03,245 DEBUG [AutoinventoryCommandsServer] AICommandsServer: asked to invoke cmd=autoinv:pushRuntimeDiscoveryConfig
2007-01-12 11:33:03,246 DEBUG [ConfigStorage] Searching for '2-10206-VMware ESX 3.x|' within '2-10202-Net Services|2-10203-ProcessServer|2-10205-NetworkServer|2-10204-FileServer|2-10207-HQ Agent|2-10206-VMware ESX 3.x|'
2007-01-12 11:33:03,248 DEBUG [ConfigStorage] Successfully stored config into storage: 2-10206-VMware ESX 3.x-->{platform.id=10151, user=root, platform.name=***********, platform.ip=***********, host=***********, pass=***********, platform.fqdn=***********, installpath=/etc/vmware, authd.client.port=902, platform.type=Linux}
2007-01-12 11:33:03,248 DEBUG [RuntimeAutodiscoverer] Triggering scan after storing config for: 2-10206-VMware ESX 3.x
2007-01-12 11:33:03,248 DEBUG [CommandListener] Method 'org.hyperic.hq.agent.AgentCommand@119e583' returned null
2007-01-12 11:33:03,248 DEBUG [SSLConnectionListener] Handling SSL connection from /10.245.64.35
2007-01-12 11:33:03,432 DEBUG [CommandListener] Dispatching request for 'rtm:scheduleMeasurements'
2007-01-12 11:33:03,432 DEBUG [MeasurementCommandsServer] Scheduling 7 metrics for 2:10206: new SRN = 167
2007-01-12 11:33:03,433 DEBUG [ScheduleThread] Unscheduling metrics for 2:10206: [94, 95, 96, 97, 98, 99, 100]
2007-01-12 11:33:03,437 DEBUG [MeasurementSchedule] Adding new SRN for entity 2:10206: Initial value = 167
2007-01-12 11:33:03,438 DEBUG [CommandListener] Method 'org.hyperic.hq.agent.AgentCommand@1bc1fb9' returned an object result
2007-01-12 11:33:03,438 DEBUG [CollectorResult] Attribute 'system.mem.size' not found
2007-01-12 11:33:03,438 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.mem.size' -> None
2007-01-12 11:33:03,440 DEBUG [CollectorResult] Attribute 'system.cpu.usedsec' not found
2007-01-12 11:33:03,440 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.usedsec__RATE__=1m' -> None
2007-01-12 11:33:03,440 DEBUG [CollectorResult] Attribute 'system.cpu.idlesec' not found
2007-01-12 11:33:03,440 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.idlesec' -> None
2007-01-12 11:33:03,440 DEBUG [CollectorResult] Attribute 'system.mem.avail' not found
2007-01-12 11:33:03,440 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.mem.avail' -> None
2007-01-12 11:33:03,440 DEBUG [ScheduleThread] [2:10206:AVAILABILITY] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:Availability' -> 1
2007-01-12 11:33:03,440 DEBUG [CollectorResult] Attribute 'system.cpu.usedsec' not found
2007-01-12 11:33:03,440 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.usedsec' -> None
2007-01-12 11:33:03,440 DEBUG [CollectorResult] Attribute 'system.cpu.idlesec' not found
2007-01-12 11:33:03,440 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.idlesec__RATE__=1m' -> None
2007-01-12 11:33:03,483 DEBUG [ConfigStorage] Successfully restored config from storage: 2-10202-Net Services-->{platform.id=10151, platform.ip=***********, platform.name=***********, platform.fqdn=***********, installpath=/, platform.type=Linux}
2007-01-12 11:33:03,484 DEBUG [ConfigStorage] Successfully restored config from storage: 2-10203-ProcessServer-->{platform.id=10151, platform.name=***********, platform.ip=***********, platform.fqdn=***********, installpath=/, platform.type=Linux}
2007-01-12 11:33:03,484 DEBUG [ConfigStorage] Successfully restored config from storage: 2-10205-NetworkServer-->{platform.id=10151, platform.name=***********, platform.ip=***********, platform.fqdn=***********, platform.type=Linux, installpath=/}
2007-01-12 11:33:03,484 DEBUG [ConfigStorage] Successfully restored config from storage: 2-10204-FileServer-->{platform.id=10151, platform.ip=***********, platform.name=***********, platform.fqdn=***********, installpath=/, platform.type=Linux}
2007-01-12 11:33:03,484 DEBUG [ConfigStorage] Successfully restored config from storage: 2-10207-HQ Agent-->{platform.id=10151, platform.name=***********, platform.ip=***********, platform.fqdn=***********, installpath=/home/hyperic/agent-2.7.6, platform.type=Linux}
2007-01-12 11:33:03,484 DEBUG [ConfigStorage] Successfully restored config from storage: 2-10206-VMware ESX 3.x-->{platform.id=10151, user=root, platform.ip=***********, platform.name=***********, host=***********, pass=***********, platform.fqdn=***********, installpath=/etc/vmware, authd.client.port=902, platform.type=Linux}
2007-01-12 11:33:03,520 DEBUG [SSLConnectionListener] Handling SSL connection from /10.245.64.35
2007-01-12 11:33:03,794 DEBUG [CommandListener] Dispatching request for 'rtm:scheduleMeasurements'
2007-01-12 11:33:03,794 DEBUG [MeasurementCommandsServer] Scheduling 7 metrics for 2:10206: new SRN = 168
2007-01-12 11:33:03,794 DEBUG [ScheduleThread] Unscheduling metrics for 2:10206: [101, 102, 103, 104, 105, 106, 107]
2007-01-12 11:33:03,801 DEBUG [MeasurementSchedule] Adding new SRN for entity 2:10206: Initial value = 168
2007-01-12 11:33:03,801 DEBUG [CommandListener] Method 'org.hyperic.hq.agent.AgentCommand@1117a20' returned an object result
2007-01-12 11:33:03,803 DEBUG [CollectorResult] Attribute 'system.mem.avail' not found
2007-01-12 11:33:03,803 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.mem.avail' -> None
2007-01-12 11:33:03,803 DEBUG [ScheduleThread] [2:10206:AVAILABILITY] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:Availability' -> 1
2007-01-12 11:33:03,804 DEBUG [CollectorResult] Attribute 'system.cpu.usedsec' not found
2007-01-12 11:33:03,804 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.usedsec__RATE__=1m' -> None
2007-01-12 11:33:03,804 DEBUG [CollectorResult] Attribute 'system.cpu.idlesec' not found
2007-01-12 11:33:03,804 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.idlesec' -> None
2007-01-12 11:33:03,804 DEBUG [CollectorResult] Attribute 'system.mem.size' not found
2007-01-12 11:33:03,804 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.mem.size' -> None
2007-01-12 11:33:03,804 DEBUG [CollectorResult] Attribute 'system.cpu.idlesec' not found
2007-01-12 11:33:03,804 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.idlesec__RATE__=1m' -> None
2007-01-12 11:33:03,804 DEBUG [CollectorResult] Attribute 'system.cpu.usedsec' not found
2007-01-12 11:33:03,804 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.usedsec' -> None
2007-01-12 11:33:03,845 DEBUG [SSLConnectionListener] Handling SSL connection from /10.245.64.35
2007-01-12 11:33:04,735 DEBUG [CommandListener] Dispatching request for 'rtm:scheduleMeasurements'
2007-01-12 11:33:04,735 DEBUG [MeasurementCommandsServer] Scheduling 7 metrics for 2:10206: new SRN = 169
2007-01-12 11:33:04,735 DEBUG [ScheduleThread] Unscheduling metrics for 2:10206: [108, 109, 110, 111, 112, 113, 114]
2007-01-12 11:33:04,740 DEBUG [MeasurementSchedule] Adding new SRN for entity 2:10206: Initial value = 169
2007-01-12 11:33:04,740 DEBUG [CommandListener] Method 'org.hyperic.hq.agent.AgentCommand@18a9fc8' returned an object result
2007-01-12 11:33:04,741 DEBUG [CollectorResult] Attribute 'system.cpu.idlesec' not found
2007-01-12 11:33:04,741 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.idlesec__RATE__=1m' -> None
2007-01-12 11:33:04,741 DEBUG [CollectorResult] Attribute 'system.cpu.usedsec' not found
2007-01-12 11:33:04,741 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.usedsec__RATE__=1m' -> None
2007-01-12 11:33:04,741 DEBUG [CollectorResult] Attribute 'system.cpu.usedsec' not found
2007-01-12 11:33:04,743 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.usedsec' -> None
2007-01-12 11:33:04,743 DEBUG [CollectorResult] Attribute 'system.cpu.idlesec' not found
2007-01-12 11:33:04,743 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.idlesec' -> None
2007-01-12 11:33:04,743 DEBUG [CollectorResult] Attribute 'system.mem.size' not found
2007-01-12 11:33:04,743 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.mem.size' -> None
2007-01-12 11:33:04,743 DEBUG [CollectorResult] Attribute 'system.mem.avail' not found
2007-01-12 11:33:04,743 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.mem.avail' -> None
2007-01-12 11:33:04,744 DEBUG [ScheduleThread] [2:10206:AVAILABILITY] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:Availability' -> 1
2007-01-12 11:33:04,806 DEBUG [SSLConnectionListener] Handling SSL connection from /10.245.64.35
2007-01-12 11:33:04,994 DEBUG [CommandListener] Dispatching request for 'rtm:scheduleMeasurements'
2007-01-12 11:33:04,994 DEBUG [MeasurementCommandsServer] Scheduling 7 metrics for 2:10206: new SRN = 170
2007-01-12 11:33:04,995 DEBUG [ScheduleThread] Unscheduling metrics for 2:10206: [115, 116, 117, 118, 119, 120, 121]
2007-01-12 11:33:05,000 DEBUG [MeasurementSchedule] Adding new SRN for entity 2:10206: Initial value = 170
2007-01-12 11:33:05,000 DEBUG [CommandListener] Method 'org.hyperic.hq.agent.AgentCommand@16504fa' returned an object result
2007-01-12 11:33:05,000 DEBUG [CollectorResult] Attribute 'system.mem.avail' not found
2007-01-12 11:33:05,000 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.mem.avail' -> None
2007-01-12 11:33:05,000 DEBUG [CollectorResult] Attribute 'system.cpu.idlesec' not found
2007-01-12 11:33:05,000 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.idlesec__RATE__=1m' -> None
2007-01-12 11:33:05,000 DEBUG [CollectorResult] Attribute 'system.cpu.idlesec' not found
2007-01-12 11:33:05,000 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.idlesec' -> None
2007-01-12 11:33:05,001 DEBUG [CollectorResult] Attribute 'system.mem.size' not found
2007-01-12 11:33:05,001 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.mem.size' -> None
2007-01-12 11:33:05,001 DEBUG [CollectorResult] Attribute 'system.cpu.usedsec' not found
2007-01-12 11:33:05,001 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.usedsec__RATE__=1m' -> None
2007-01-12 11:33:05,001 DEBUG [CollectorResult] Attribute 'system.cpu.usedsec' not found
2007-01-12 11:33:05,001 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.usedsec' -> None
2007-01-12 11:33:05,001 DEBUG [ScheduleThread] [2:10206:AVAILABILITY] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:Availability' -> 1
2007-01-12 11:33:05,039 DEBUG [SSLConnectionListener] Handling SSL connection from /10.245.64.35
2007-01-12 11:33:05,290 DEBUG [CommandListener] Dispatching request for 'rtm:scheduleMeasurements'
2007-01-12 11:33:05,290 DEBUG [MeasurementCommandsServer] Scheduling 7 metrics for 2:10206: new SRN = 171
2007-01-12 11:33:05,290 DEBUG [ScheduleThread] Unscheduling metrics for 2:10206: [122, 123, 124, 125, 126, 127, 128]
2007-01-12 11:33:05,295 DEBUG [MeasurementSchedule] Adding new SRN for entity 2:10206: Initial value = 171
2007-01-12 11:33:05,295 DEBUG [CommandListener] Method 'org.hyperic.hq.agent.AgentCommand@b85c17' returned an object result
2007-01-12 11:33:05,296 DEBUG [CollectorResult] Attribute 'system.cpu.usedsec' not found
2007-01-12 11:33:05,296 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.usedsec__RATE__=1m' -> None
2007-01-12 11:33:05,296 DEBUG [CollectorResult] Attribute 'system.cpu.idlesec' not found
2007-01-12 11:33:05,296 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.idlesec__RATE__=1m' -> None
2007-01-12 11:33:05,296 DEBUG [ScheduleThread] [2:10206:AVAILABILITY] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:Availability' -> 1
2007-01-12 11:33:05,296 DEBUG [CollectorResult] Attribute 'system.mem.avail' not found
2007-01-12 11:33:05,296 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.mem.avail' -> None
2007-01-12 11:33:05,296 DEBUG [CollectorResult] Attribute 'system.cpu.idlesec' not found
2007-01-12 11:33:05,296 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.idlesec' -> None
2007-01-12 11:33:05,296 DEBUG [CollectorResult] Attribute 'system.cpu.usedsec' not found
2007-01-12 11:33:05,296 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.cpu.usedsec' -> None
2007-01-12 11:33:05,296 DEBUG [CollectorResult] Attribute 'system.mem.size' not found
2007-01-12 11:33:05,296 DEBUG [ScheduleThread] [2:10206:UTILIZATION] Metric='VMware ESX 3.x:server:authd.client.port=902,host=***********,user=root,pass=***********:system.mem.size' -> None
2007-01-12 11:33:07,143 DEBUG [Collector] Running VMware ESX 3.x collectors
2007-01-12 11:33:07,172 DEBUG [Collector] Fri Jan 12 11:33:07 CET 2007 [Error] (VMware ESX 3.x) Invalid arguments: Login failed. values={Availability=1.0}
2007-01-12 11:33:08,363 DEBUG [SSLConnectionListener] Handling SSL connection from /10.245.64.35
2007-01-12 11:33:08,493 INFO [RuntimeAutodiscoverer] Running runtime autodiscovery for Net Services
2007-01-12 11:33:08,502 DEBUG [NetServicesDetector] no services discovered
2007-01-12 11:33:08,502 INFO [RuntimeAutodiscoverer] Net Services discovery took 0.001
2007-01-12 11:33:08,502 INFO [RuntimeAutodiscoverer] Running runtime autodiscovery for VMware ESX 3.x
2007-01-12 11:33:08,536 WARN [RuntimeAutodiscoverer] Error running autodiscoverer for plugin: VMware ESX 3.x: Error discovering VMs: Invalid arguments: Login failed.
org.hyperic.hq.product.PluginException: Error discovering VMs: Invalid arguments: Login failed.
[1]-NESTED-EXCEPTION:
org.hyperic.sigar.vmware.VMwareException: Invalid arguments: Login failed.
at org.hyperic.hq.plugin.vmware.VMwareDetector.getServices(VMwareDetector.java:505)
at org.hyperic.hq.plugin.vmware.VMwareDetector.discoverServices(VMwareDetector.java:391)
at org.hyperic.hq.product.ServerDetector.discoverResources(ServerDetector.java:191)
at org.hyperic.hq.autoinventory.agent.server.RuntimeAutodiscoverer.doRuntimeScan_internal(RuntimeAutodiscoverer.java:292)
at org.hyperic.hq.autoinventory.agent.server.RuntimeAutodiscoverer.doRuntimeScan(RuntimeAutodiscoverer.java:220)
at org.hyperic.hq.autoinventory.ScanManager.mainRunLoop(ScanManager.java:165)
at org.hyperic.hq.autoinventory.ScanManager.access$000(ScanManager.java:41)
at org.hyperic.hq.autoinventory.ScanManager$1.run(ScanManager.java:107)
Caused by: org.hyperic.sigar.vmware.VMwareException: Invalid arguments: Login failed.
at org.hyperic.sigar.vmware.VMwareServer.connect(Native Method)
at org.hyperic.hq.plugin.vmware.VMwareDetector.getServices(VMwareDetector.java:480)
... 7 more
2007-01-12 11:33:08,537 INFO [RuntimeAutodiscoverer] Running runtime autodiscovery for HQ Agent
2007-01-12 11:33:08,543 DEBUG [AgentServerDetector] no services discovered
2007-01-12 11:33:08,543 INFO [RuntimeAutodiscoverer] HQ Agent discovery took 0.000
2007-01-12 11:33:08,543 INFO [RuntimeAutodiscoverer] Running runtime autodiscovery for NetworkServer
2007-01-12 11:33:08,548 DEBUG [SystemServerDetector] discovered *********** Linux Network Interface lo (loopback) [NetworkServer Interface]
2007-01-12 11:33:08,548 DEBUG [SystemServerDetector] discovered *********** Linux Network Interface vswif0 (ethernet) [NetworkServer Interface]
2007-01-12 11:33:08,548 DEBUG [SystemServerDetector] discovered *********** Linux Network Interface vmnic1 (ethernet) [NetworkServer Interface]
2007-01-12 11:33:08,550 DEBUG [SystemServerDetector] discovered *********** Linux Network Interface vmnic0 (ethernet) [NetworkServer Interface]
2007-01-12 11:33:08,550 INFO [RuntimeAutodiscoverer] NetworkServer discovery took 0.003
2007-01-12 11:33:08,550 INFO [RuntimeAutodiscoverer] Running runtime autodiscovery for ProcessServer
2007-01-12 11:33:08,555 DEBUG [SystemServerDetector] discovered *********** Linux CPU 1 (1862Mhz Intel Xeon) [CPU]
2007-01-12 11:33:08,555 DEBUG [SystemServerDetector] discovered *********** Linux sshd Process [Process]
2007-01-12 11:33:08,557 DEBUG [AutoinventoryPluginManager] Get service configs Process=null
2007-01-12 11:33:08,557 DEBUG [SystemServerDetector] User AI is disabled=null
2007-01-12 11:33:08,558 INFO [RuntimeAutodiscoverer] ProcessServer discovery took 0.002
Reply
0 Kudos
nickyhaan
Contributor
Contributor
Jump to solution

btw ..cwitt .. maybe you should change the info's regarding installing in vmware to refer that the firewallthing is only needed on esx 3.0 .. 2.xx didnt have a fw..
Reply
0 Kudos
cwitt_hyperic
Hot Shot
Hot Shot
Jump to solution

Thanks for the catch in the docs. I have corrected the information regarding the VMware version specific to the firewall configuration requirements.

Back to your problem...

If you are using the root account, and have had similar problems with the firewall turned on and off, we could be looking at possible bug.

Does the excessive number of auth connections to port 902 go away (or down) when you shutdown the HQ Agent on the ESX box?

Can you check the build version of ESX 3 you have installed? You can find this information at the top of the information screen for the ESX host within the Virtual Infrastructure Client, or by running `vmware -v` at the command-line. I'd just like to know if there is a build/patch version difference between my test ESX 3.0.1 box (VMware ESX Server 3.0.1 build-32039), and the machine with which you are working.

This information and the logs you've provided should at least give us a starting point. If there is a bug somewhere, this information would be useful in isolating it.
Reply
0 Kudos
cwitt_hyperic
Hot Shot
Hot Shot
Jump to solution

I think we may now understand the problem you are having thanks to the DEBUG info from your log. It looks like the authd.client.port is set incorrectly in the Confguration Properties for the VMware Server. The default for ESX 3 is port 443. Also on the Configuration Properties page, although the user, pass, and host fields are marked as required fields in the web UI, they are not required by the plugin. This is a bug.

Two possible workarounds for this issue are:

1. Browse to the resource page for the VMware ESX 3.x Server, click on the Inventory tab, and find the Edit button for Configuration Properties (bottom of the page). In the field for authd.client.port, replace 902 with 0. 0 tells the agent to use the default. Click OK. Give the agent a little while to collect and report new findings to the HQ Server.

IF THAT FAILS TO SOLVE THE ISSUE,

2. Browse to the resource page for the Platform (host) running your VMware ESX 3.x Server, click on the Inventory tab, find the Servers section, select the check-box next to the VMware ESX 3.x Server definition, and click Delete to remove it. It should get re-added through auto-discovery if the agent is now running with the appropriate permissions.

Let me know if these instructions solve your problem.
Reply
0 Kudos
nickyhaan
Contributor
Contributor
Jump to solution

ok .. this is allready better.. but first of all, autodetect didnt work for the settings in hyperic, when trying to put in 0 for port, it complains about the port needing to be between 1 and 65535, changing the settings on the allready running agent didnt work either, so i killed it from the admin machine, and deleted the data folder on the agent machine, after reinitializing and putting in the right credentials and port 443 (please note that the authd.client.port is 902 ..and not 443, check /etc/vmware/config for that authd.client.port = "902", so i obviously thought thats whats needed in the settings, maybe just state port 443 there ??) i then started the inventory, which took quite long (10+ minutes) and load and memory was quite up on the esx server (this is a dual quad xeon machine with 16 gigs and about 20 vitrual machines running).. the agent is now running, but somehow i think its timing out a lot, the availability is always on yellow ... i think that the agent needs some more tweaking here ... on a esx 3.0 server there is only 1 cpu and limited memory available for the linux hostmachine .. maybe this is not enough for the agent ?
Reply
0 Kudos
nickyhaan
Contributor
Contributor
Jump to solution

ow .. on version numbers .. the box i'm talking about is:
VMware ESX Server 3.0.1 build-35804

i also installed the agent on another esx server, hosting only 4 virtual machines without any dropouts:
VMware ESX Server 3.0.1 build-35804, although webinterface says 34176
Reply
0 Kudos
cwitt_hyperic
Hot Shot
Hot Shot
Jump to solution

There is a difference between the patch sets I have installed on my test box, and the build version your machine is currently reporting. It appears we do not have all the patch sets installed that you do. If you get an opportunity, can you run:

esxupdate query

This will list all the patch updates that have been installed on your ESX box(es), and may help us find the issue you are having. Especially interested in finding what (if any) differences exist between your two machines since one is working fine with the HQ Agent, and the other is not.
Reply
0 Kudos
nickyhaan
Contributor
Contributor
Jump to solution

hi .. the box that is working has:
Installed software bundles:
------ Name ------ --- Install Date --- --- Summary ---
3.0.1-32039 23:06:43 01/03/07 Full 3.0.1 release of VMware ESX Server
ESX-1006511 13:22:09 01/05/07 Fixing TX hang in 80003ES2LAN Controller
ESX-1410076 13:26:11 01/05/07 BSOD 0x109 during 64-bit Windows install
ESX-2066306 13:27:14 01/05/07 Patch for VM crashes and possible freeze
ESX-2158032 13:29:00 01/05/07 Add LFENCE for RWO on AMD K8 before RevF
For a differential list of rpms, use the -l/--listrpms option.

the box which has dropped availability packets:
------ Name ------ --- Install Date --- --- Summary ---
3.0.1-32039 13:18:00 12/22/06 Full 3.0.1 release of VMware ESX Server
ESX-2066306 13:43:17 12/29/06 Patch for VM crashes and possible freeze
ESX-2158032 13:48:14 12/29/06 Add LFENCE for RWO on AMD K8 before RevF
ESX-6921838 14:35:54 12/29/06 hot removal of a virtual disk thru SDK
For a differential list of rpms, use the -l/--listrpms option.
Reply
0 Kudos
cwitt_hyperic
Hot Shot
Hot Shot
Jump to solution

Thanks. These are good data points.
Reply
0 Kudos
dougm_hyperic
VMware Employee
VMware Employee
Jump to solution

Hi Nicky,

We'll clear up the port confusion for the next release. As for
availability being yellow, I believe this is due to the combination
of the VMware API in 3.0 being much slower than ESX 2 times the 20
VMs exposes this recently fixed issue: http://jira.hyperic.com/browse/
HHQ-437

You'll find a patch attached to the issue which should fix your
availability lights. Let us know if that helps. It is also possible
to decrease the memory usage by disabling plugins other than vmware
buy adding the following to agent.properties:

plugins.include=vmware

You can also change the max heap size in agent.properties:
agent.javaOpts=-Xmx128m

On Jan 15, 2007, at 3:52 AM, Nicky Haan wrote:

> ok .. this is allready better.. but first of all, autodetect didnt
> work for the settings in hyperic, when trying to put in 0 for port,
> it complains about the port needing to be between 1 and 65535,
> changing the settings on the allready running agent didnt work
> either, so i killed it from the admin machine, and deleted the data
> folder on the agent machine, after reinitializing and putting in
> the right credentials and port 443 (please note that the
> authd.client.port is 902 ..and not 443, check /etc/vmware/config
> for that authd.client.port = "902", so i obviously thought thats
> whats needed in the settings, maybe just state port 443 there ??) i
> then started the inventory, which took quite long (10+ minutes) and
> load and memory was quite up on the esx server (this is a dual quad
> xeon machine with 16 gigs and about 20 vitrual machines running)..
> the agent is now running, but somehow i think its timing out a lot,
> the availability is always on yellow ... i think that the agent
> needs some more tweaking here ... on a esx 3.0 server there is only
> 1 cpu and limited memory available for the linux hostmachine ..
> maybe this is not enough for the agent ?
>



Reply
0 Kudos
nickyhaan
Contributor
Contributor
Jump to solution

OK,

this did the tric.. looks smooth now for the last 4 hours .. although the agent.javaOpts=-Xmx128m is default in the agent properties ..

i do have quite a load being caused by the hyperic agent on my vmware machine

root 14562 6.4 31.7 398652 85240 pts/0 S 09:11 16:29 /home/hyperic/agent-2.7.6/jre/bin/java -client -Dagent.propFile=agent.properties -Dorg.hyperic.hq.bizapp.agent.CommandsAPIInfo.camUpPor

load is permanently on 1.10 ... (esx 3.0 only "gives" one cpu for the console, the rest is exclusivly used for virtual machines)
Reply
0 Kudos