Strange with Fastpath service and Spark

Dear All,

I got a strange problem with Fastpath service, i’m curenntly using openfire 3.6.4 and Spark 2.5.8 on Linux

i already have a Fastpath configuration like group and user for helpdesk example,

the problem is, if i running Spark using ordinary user the Workgroup member in Fastpath wont appear always “waiting for member”, but in session menus i already login.

and if i running the Spark agent with a root user,Fastpath recognize me and i can use the service… strange

does anyone know about this problem? i think its a port problem,but i dont know which port Spark used.

Thanks.

note: i apologize for my bad english

Is ordinary user set up as a Fastpath agent? When Fastpath does not appear, is the offline message shown instead? There is some bug that causes this, and I have found restarting the Fastpath plugin or closing and re-opening the workgroup queue sometimes resets its state. Spark typically connects using network port 5222, and is built to recognize the Fastpath XMPP extension.

hai,thanks for quick reply,

yes, i setup several user as a Fastpath agent, the offline message appear if the user run the IM client ( Spark ) with user permission,not using root. but if they using root for running spark its running well,and the workgroup appears. Before i found about using Spark with root, i already test it,with unistall the fastpath plugins and install it again,reset the plugins, but nothing happen.

if Spark use port 5222,whether there is a possibility Fasthpath use another port that only root can use the Fastpath port?

i confuse about this,

thanks

Which version of Openfire are you running? In 3.7.0 Beta, I’ve seen forum posts that say it has not yet been updated to work.

Which OS are you running?

One suggestion is to turn on debugging mode in the Openfire console to see what clues are there. If you could post the logs, others can advise if they see something.

Spark uses the same 5222 port to receive Fastpath XMPP extension messages, I believe. If in doubt, use tcpdump and netstat utilities to observe the network ports usage/traffic.

Hope that helps.

hai slicer321.

i’m curenntly using openfire 3.6.4 and Spark 2.5.8

Im using Centos5.5

i already turn on the debug mode,

this is my debug file

2010.12.20 13:39:51 NIOConnection: startTLS: using c2s
2010.12.20 13:39:51 LdapManager: Trying to find a user’s DN based on their username. uid: vash27, Base DN: ou=ADMIN,ou=Accounts,dc=vash27,dc=com…
2010.12.20 13:39:51 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.20 13:39:51 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.20 13:39:51 LdapManager: … context created successfully, returning.
2010.12.20 13:39:51 LdapManager: Starting LDAP search…
2010.12.20 13:39:51 LdapManager: … search finished
2010.12.20 13:39:51 LdapManager: In LdapManager.checkAuthentication(userDN, password), userDN is: uid=“vash27”…
2010.12.20 13:39:51 LdapManager: Created context values, attempting to create context…
2010.12.20 13:39:51 LdapManager: … context created successfully, returning.
2010.12.20 13:39:51 AuthorizationManager: Trying Default Mapping.map(vash27)
2010.12.20 13:39:51 DefaultAuthorizationMapping: No realm found
2010.12.20 13:39:51 AuthorizationManager: Trying Default Policy.authorize(vash27 , vash27)
2010.12.20 13:39:51 DefaultAuthorizationPolicy: Checking authenID realm
2010.12.20 13:39:51 LdapManager: Trying to find a user’s DN based on their username. uid: vash27, Base DN: ou=ADMIN,ou=Accounts,dc=vash27,dc=com…
2010.12.20 13:39:51 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.20 13:39:51 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.20 13:39:51 LdapManager: … context created successfully, returning.
2010.12.20 13:39:51 LdapManager: Starting LDAP search…
2010.12.20 13:39:51 LdapManager: … search finished
2010.12.20 13:39:51 LdapManager: Trying to find a user’s DN based on their username. uid: vash27, Base DN: ou=ADMIN,ou=Accounts,dc=vash27,dc=com…
2010.12.20 13:39:51 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.20 13:39:51 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.20 13:39:52 LdapManager: … context created successfully, returning.
2010.12.20 13:39:52 LdapManager: Starting LDAP search…
2010.12.20 13:39:52 LdapManager: … search finished
2010.12.20 13:39:52 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.20 13:39:52 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.20 13:39:52 LdapManager: … context created successfully, returning.

no error found, even in the error.log and warn.log is clean…

Ah, you have implemented LDAP authentication. What is the log for a user that is non-root trying use Fastpath as agent?

Hai thanks for the reply,

I compare the debug.log file between using Spark as ordinary user and Spark as root user.

from the debug.log I found the different

using root:

  1. if i use root user the connection use this:

2010.12.21 09:36:22 NIOConnection: startTLS: using c2s

  1. the server seem not load the vcard? and i don’t know the vcard function.

using ordinary user:

1.there’s no nioconnection

2.using the LDAPVCardProvider

** 2010.12.21 09:33:56 LdapVCardProvider: Found attribute uid of type: class java.lang.String**

this is the complete debug.log maybe i’m missing something.

running Spark as Root:

Today: Tuesday, December 21 2010

2010.12.21 09:36:22 NIOConnection: startTLS: using c2s
2010.12.21 09:36:22 LdapManager: Trying to find a user’s DN based on their username. uid: vash27, Base DN: ou=ADMIN,ou=Accounts,dc=vash27,dc=com…
2010.12.21 09:36:22 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:36:22 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:36:22 LdapManager: … context created successfully, returning.
2010.12.21 09:36:22 LdapManager: Starting LDAP search…
2010.12.21 09:36:22 LdapManager: … search finished
2010.12.21 09:36:22 LdapManager: In LdapManager.checkAuthentication(userDN, password), userDN is: uid=“vash27”…
2010.12.21 09:36:22 LdapManager: Created context values, attempting to create context…
2010.12.21 09:36:23 LdapManager: … context created successfully, returning.
2010.12.21 09:36:23 AuthorizationManager: Trying Default Mapping.map(vash27)
2010.12.21 09:36:23 DefaultAuthorizationMapping: No realm found
2010.12.21 09:36:23 AuthorizationManager: Trying Default Policy.authorize(vash27 , vash27)
2010.12.21 09:36:23 DefaultAuthorizationPolicy: Checking authenID realm
2010.12.21 09:36:23 LdapManager: Trying to find a user’s DN based on their username. uid: vash27, Base DN: ou=ADMIN,ou=Accounts,dc=vash27,dc=com…
2010.12.21 09:36:23 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:36:23 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:36:23 LdapManager: … context created successfully, returning.
2010.12.21 09:36:23 LdapManager: Starting LDAP search…
2010.12.21 09:36:23 LdapManager: … search finished
2010.12.21 09:36:23 LdapManager: Trying to find a user’s DN based on their username. uid: vash27, Base DN: ou=ADMIN,ou=Accounts,dc=vash27,dc=com…
2010.12.21 09:36:23 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:36:23 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:36:23 LdapManager: … context created successfully, returning.
2010.12.21 09:36:23 LdapManager: Starting LDAP search…
2010.12.21 09:36:23 LdapManager: … search finished
2010.12.21 09:36:23 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:36:23 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:36:23 LdapManager: … context created successfully, returning.

running Spark as ordinary user:

Today: Monday, December 20 2010

2010.12.21 09:33:53 LdapManager: Trying to find a user’s DN based on their username. uid: vash27, Base DN: ou=ADMIN,ou=Accounts,dc=vash27,dc=com…
2010.12.21 09:33:53 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:33:53 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:33:53 LdapManager: … context created successfully, returning.
2010.12.21 09:33:53 LdapManager: Starting LDAP search…
2010.12.21 09:33:53 LdapManager: … search finished
2010.12.21 09:33:53 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:33:53 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:33:53 LdapManager: … context created successfully, returning.
2010.12.21 09:33:54 LdapManager: Trying to find a user’s DN based on their username. uid: vash27, Base DN: ou=ADMIN,ou=Accounts,dc=vash27,dc=com…
2010.12.21 09:33:54 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:33:54 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:33:54 LdapManager: … context created successfully, returning.
2010.12.21 09:33:54 LdapManager: Starting LDAP search…
2010.12.21 09:33:54 LdapManager: … search finished
2010.12.21 09:33:54 LdapManager: Trying to find a user’s DN based on their username. uid: vash27, Base DN: ou=ADMIN,ou=Accounts,dc=vash27,dc=com…
2010.12.21 09:33:54 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:33:54 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:33:54 LdapManager: … context created successfully, returning.
2010.12.21 09:33:54 LdapManager: Starting LDAP search…
2010.12.21 09:33:54 LdapManager: … search finished
2010.12.21 09:33:54 Trying to find group names for user:vash27@vash27.com using query: (&(cn=*)(member=uid=“vash27”,ou=ADMIN,ou=Accounts,dc=vash27,dc=com))
2010.12.21 09:33:54 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:33:54 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:33:54 LdapManager: … context created successfully, returning.
2010.12.21 09:33:55 LdapManager: Trying to find a user’s DN based on their username. uid: vash27, Base DN: ou=ADMIN,ou=Accounts,dc=vash27,dc=com…
2010.12.21 09:33:55 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:33:55 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:33:55 LdapManager: … context created successfully, returning.
2010.12.21 09:33:55 LdapManager: Starting LDAP search…
2010.12.21 09:33:55 LdapManager: … search finished
2010.12.21 09:33:55 LdapManager: Trying to find a user’s DN based on their username. uid: vash27, Base DN: ou=ADMIN,ou=Accounts,dc=vash27,dc=com…
2010.12.21 09:33:55 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:33:55 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:33:55 LdapManager: … context created successfully, returning.
2010.12.21 09:33:55 LdapManager: Starting LDAP search…
2010.12.21 09:33:55 LdapManager: … search finished
2010.12.21 09:33:55 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:33:55 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:33:56 LdapManager: … context created successfully, returning.
2010.12.21 09:33:56 LdapVCardProvider: Found attribute uid of type: class java.lang.String
2010.12.21 09:33:56 LdapVCardProvider: Ldap attribute ‘uid’=>'vash27’
2010.12.21 09:33:56 LdapVCardProvider: No ldap value found for attribute ‘mail’
2010.12.21 09:33:56 LdapVCardProvider: Ldap attribute ‘mail’=>’'
2010.12.21 09:33:56 LdapVCardProvider: Found attribute cn of type: class java.lang.String
2010.12.21 09:33:56 LdapVCardProvider: Ldap attribute ‘cn’=>'vash27’
2010.12.21 09:33:56 LdapVCardProvider: No ldap value found for attribute ‘displayName’
2010.12.21 09:33:56 LdapVCardProvider: Ldap attribute ‘displayName’=>’'
2010.12.21 09:33:56 LdapVCardProvider: Getting mapped vcard for vash27
2010.12.21 09:33:56 LdapVCardProvider: Returning vcard

Hai thanks for the reply,

I compare the debug.log file between using Spark as ordinary user and Spark as root user.

from the debug.log I found the different

using root:

  1. if i use root user the connection use this:

2010.12.21 09:36:22 NIOConnection: startTLS: using c2s

  1. the server seem not load the vcard? and i don’t know the vcard function.

using ordinary user:

1.there’s no nioconnection

2.using the LDAPVCardProvider

** 2010.12.21 09:33:56 LdapVCardProvider: Found attribute uid of type: class java.lang.String**

this is the complete debug.log maybe i’m missing something.

running Spark as Root:

Today: Tuesday, December 21 2010

2010.12.21 09:36:22 NIOConnection: startTLS: using c2s
2010.12.21 09:36:22 LdapManager: Trying to find a user’s DN based on their username. uid: vash27, Base DN: ou=ADMIN,ou=Accounts,dc=vash27,dc=com…
2010.12.21 09:36:22 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:36:22 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:36:22 LdapManager: … context created successfully, returning.
2010.12.21 09:36:22 LdapManager: Starting LDAP search…
2010.12.21 09:36:22 LdapManager: … search finished
2010.12.21 09:36:22 LdapManager: In LdapManager.checkAuthentication(userDN, password), userDN is: uid=“vash27”…
2010.12.21 09:36:22 LdapManager: Created context values, attempting to create context…
2010.12.21 09:36:23 LdapManager: … context created successfully, returning.
2010.12.21 09:36:23 AuthorizationManager: Trying Default Mapping.map(vash27)
2010.12.21 09:36:23 DefaultAuthorizationMapping: No realm found
2010.12.21 09:36:23 AuthorizationManager: Trying Default Policy.authorize(vash27 , vash27)
2010.12.21 09:36:23 DefaultAuthorizationPolicy: Checking authenID realm
2010.12.21 09:36:23 LdapManager: Trying to find a user’s DN based on their username. uid: vash27, Base DN: ou=ADMIN,ou=Accounts,dc=vash27,dc=com…
2010.12.21 09:36:23 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:36:23 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:36:23 LdapManager: … context created successfully, returning.
2010.12.21 09:36:23 LdapManager: Starting LDAP search…
2010.12.21 09:36:23 LdapManager: … search finished
2010.12.21 09:36:23 LdapManager: Trying to find a user’s DN based on their username. uid: vash27, Base DN: ou=ADMIN,ou=Accounts,dc=vash27,dc=com…
2010.12.21 09:36:23 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:36:23 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:36:23 LdapManager: … context created successfully, returning.
2010.12.21 09:36:23 LdapManager: Starting LDAP search…
2010.12.21 09:36:23 LdapManager: … search finished
2010.12.21 09:36:23 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:36:23 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:36:23 LdapManager: … context created successfully, returning.

running Spark as ordinary user:

Today: Monday, December 20 2010

2010.12.21 09:33:53 LdapManager: Trying to find a user’s DN based on their username. uid: vash27, Base DN: ou=ADMIN,ou=Accounts,dc=vash27,dc=com…
2010.12.21 09:33:53 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:33:53 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:33:53 LdapManager: … context created successfully, returning.
2010.12.21 09:33:53 LdapManager: Starting LDAP search…
2010.12.21 09:33:53 LdapManager: … search finished
2010.12.21 09:33:53 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:33:53 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:33:53 LdapManager: … context created successfully, returning.
2010.12.21 09:33:54 LdapManager: Trying to find a user’s DN based on their username. uid: vash27, Base DN: ou=ADMIN,ou=Accounts,dc=vash27,dc=com…
2010.12.21 09:33:54 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:33:54 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:33:54 LdapManager: … context created successfully, returning.
2010.12.21 09:33:54 LdapManager: Starting LDAP search…
2010.12.21 09:33:54 LdapManager: … search finished
2010.12.21 09:33:54 LdapManager: Trying to find a user’s DN based on their username. uid: vash27, Base DN: ou=ADMIN,ou=Accounts,dc=vash27,dc=com…
2010.12.21 09:33:54 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:33:54 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:33:54 LdapManager: … context created successfully, returning.
2010.12.21 09:33:54 LdapManager: Starting LDAP search…
2010.12.21 09:33:54 LdapManager: … search finished
2010.12.21 09:33:54 Trying to find group names for user:vash27@vash27.com using query: (&(cn=*)(member=uid=“vash27”,ou=ADMIN,ou=Accounts,dc=vash27,dc=com))
2010.12.21 09:33:54 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:33:54 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:33:54 LdapManager: … context created successfully, returning.
2010.12.21 09:33:55 LdapManager: Trying to find a user’s DN based on their username. uid: vash27, Base DN: ou=ADMIN,ou=Accounts,dc=vash27,dc=com…
2010.12.21 09:33:55 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:33:55 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:33:55 LdapManager: … context created successfully, returning.
2010.12.21 09:33:55 LdapManager: Starting LDAP search…
2010.12.21 09:33:55 LdapManager: … search finished
2010.12.21 09:33:55 LdapManager: Trying to find a user’s DN based on their username. uid: vash27, Base DN: ou=ADMIN,ou=Accounts,dc=vash27,dc=com…
2010.12.21 09:33:55 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:33:55 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:33:55 LdapManager: … context created successfully, returning.
2010.12.21 09:33:55 LdapManager: Starting LDAP search…
2010.12.21 09:33:55 LdapManager: … search finished
2010.12.21 09:33:55 LdapManager: Creating a DirContext in LdapManager.getContext()…
2010.12.21 09:33:55 LdapManager: Created hashtable with context values, attempting to create context…
2010.12.21 09:33:56 LdapManager: … context created successfully, returning.
2010.12.21 09:33:56 LdapVCardProvider: Found attribute uid of type: class java.lang.String
2010.12.21 09:33:56 LdapVCardProvider: Ldap attribute ‘uid’=>'vash27’
2010.12.21 09:33:56 LdapVCardProvider: No ldap value found for attribute ‘mail’
2010.12.21 09:33:56 LdapVCardProvider: Ldap attribute ‘mail’=>’'
2010.12.21 09:33:56 LdapVCardProvider: Found attribute cn of type: class java.lang.String
2010.12.21 09:33:56 LdapVCardProvider: Ldap attribute ‘cn’=>'vash27’
2010.12.21 09:33:56 LdapVCardProvider: No ldap value found for attribute ‘displayName’
2010.12.21 09:33:56 LdapVCardProvider: Ldap attribute ‘displayName’=>’'
2010.12.21 09:33:56 LdapVCardProvider: Getting mapped vcard for vash27
2010.12.21 09:33:56 LdapVCardProvider: Returning vcard

Hai,

I found this error when running Spark as a user,

Dec 21, 2010 5:51:45 PM org.jivesoftware.spark.util.log.Log error
SEVERE:
java.util.zip.ZipException: error in opening zip file
at java.util.zip.ZipFile.open(Native Method)
at java.util.zip.ZipFile.(Unknown Source)
at java.util.jar.JarFile.(Unknown Source)
at java.util.jar.JarFile.(Unknown Source)
at org.jivesoftware.spark.plugin.PluginClassLoader.checkForSmackProviders(PluginCl assLoader.java:97)
at org.jivesoftware.spark.plugin.PluginClassLoader.addPlugin(PluginClassLoader.jav a:87)
at org.jivesoftware.spark.PluginManager.loadPublicPlugins(PluginManager.java:531)
at org.jivesoftware.spark.PluginManager.loadPlugins(PluginManager.java:170)
at org.jivesoftware.spark.Workspace$4.run(Workspace.java:257)
at java.util.concurrent.Executors$RunnableAdapter.call(Unknown Source)
at java.util.concurrent.FutureTask$Sync.innerRun(Unknown Source)
at java.util.concurrent.FutureTask.run(Unknown Source)
at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(Unknown Source)
at java.util.concurrent.ThreadPoolExecutor$Worker.run(Unknown Source)
at java.lang.Thread.run(Unknown Source)
Dec 21, 2010 5:51:45 PM org.jivesoftware.spark.util.log.Log error
SEVERE:
java.util.zip.ZipException: error in opening zip file
at java.util.zip.ZipFile.open(Native Method)
at java.util.zip.ZipFile.(Unknown Source)
at java.util.jar.JarFile.(Unknown Source)
at java.util.jar.JarFile.(Unknown Source)
at org.jivesoftware.spark.plugin.PluginClassLoader.checkForSmackProviders(PluginCl assLoader.java:97)
at org.jivesoftware.spark.plugin.PluginClassLoader.addPlugin(PluginClassLoader.jav a:87)
at org.jivesoftware.spark.PluginManager.loadPublicPlugins(PluginManager.java:531)
at org.jivesoftware.spark.PluginManager.loadPlugins(PluginManager.java:170)
at org.jivesoftware.spark.Workspace$4.run(Workspace.java:257)
at java.util.concurrent.Executors$RunnableAdapter.call(Unknown Source)
at java.util.concurrent.FutureTask$Sync.innerRun(Unknown Source)
at java.util.concurrent.FutureTask.run(Unknown Source)
at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(Unknown Source)
at java.util.concurrent.ThreadPoolExecutor$Worker.run(Unknown Source)
at java.lang.Thread.run(Unknown Source)
Exception in thread “Thread-15” java.lang.ClassCastException: org.jivesoftware.smack.PacketReader$4 cannot be cast to com.jivesoftware.smack.workgroup.packet.AgentWorkgroups
at com.jivesoftware.smack.workgroup.agent.Agent.getWorkgroups(Unknown Source)
at com.jivesoftware.fastpath.FastpathPlugin$1.construct(FastpathPlugin.java:94)
at org.jivesoftware.spark.util.SwingWorker$2.run(SwingWorker.java:129)
at java.lang.Thread.run(Unknown Source)

maybe permission problem?

coz when running as root, I can acces emoticons in Spark.

thanks for the reply.