• Bug
  • Status: Closed
  • 2 Major
  • Resolution: Fixed
  • SpringRuntime
  • hsingh
  • Reporter: hhuynh
  • January 03, 2009
  • 0
  • Watchers: 0
  • February 12, 2013
  • February 10, 2009

Description

I didn’t have any logging turned on in tc-config.xml and by default, there’s log entry for every clustered event that is fired in Spring. Seem really cluttered and should only printed out if user turns on logging.

Something like this:

INFO: 0B0C0A0A08060B06040C040C010F0C0A Publishing event mandelbrot.SegmentEvent[source=mandelbrot.MandelbrotModel@168fb89] to org.springframework.context.support.ClassPathXmlApplicationContext: display name [org.springframework.context.support.ClassPathXmlApplicationContext;hashCode=27809838]; startup date [Sat Jan 03 13:13:16 PST 2009]; root of context hierarchy Thread[Thread-14,5,main] Jan 3, 2009 1:13:45 PM com.tcspring.ApplicationContextEventProtocol multicastEvent INFO: 0B0C0A0A08060B06040C040C010F0C0A Publishing event mandelbrot.SegmentEvent[source=mandelbrot.MandelbrotModel@168fb89] to org.springframework.context.support.ClassPathXmlApplicationContext: display name [org.springframework.context.support.ClassPathXmlApplicationContext;hashCode=27809838]; startup date [Sat Jan 03 13:13:16 PST 2009]; root of context hierarchy Thread[WorkerThread(dmi_stage,0),5,TC Thread Group] Jan 3, 2009 1:13:45 PM com.tcspring.ApplicationContextEventProtocol multicastEvent INFO: 0B0C0A0A08060B06040C040C010F0C0A Publishing event mandelbrot.SegmentEvent[source=mandelbrot.MandelbrotModel@168fb89] to org.springframework.context.support.ClassPathXmlApplicationContext: display name [org.springframework.context.support.ClassPathXmlApplicationContext;hashCode=27809838]; startup date [Sat Jan 03 13:13:16 PST 2009]; root of context hierarchy Thread[WorkerThread(dmi_stage,0),5,TC Thread Group] Jan 3, 2009 1:13:45 PM com.tcspring.ApplicationContextEventProtocol multicastEvent

Comments

Chris Dennis 2009-02-10

Changed logging level on these message to DEBUG (was INFO). Logging can be re-enabled through normal Spring commons-logging configuration. Verified using spring event demo in kit.

Himadri Singh 2009-03-23

Spring event demo logs on 2.7.3-ee

Using CATALINA_BASE: tomcat2 Using CATALINA_HOME: “......”\vendors\tomcat5.5 Using CATALINA_TMPDIR: tomcat2\temp Using JRE_HOME: C:\Program Files\Java\jdk1.6.0_07 2009-03-23 11:52:40,687 INFO - Terracotta Enterprise 2.7.3, as of 20090121-100140 (Revision 3286-11331 by cruise@WXPMO0 from 2.7) 2009-03-23 11:52:41,546 INFO - Configuration loaded from the file at ‘C:\Terracotta\terracotta-2.7.3-ee\samples\spring\events\tc-config.xml’. 2009-03-23 11:52:42,000 INFO - Log file: ‘C:\Terracotta\terracotta-2.7.3-ee\samples\spring\events\terracotta\client-logs\spring\events\20090323115241937\terracotta-client.log’. 2009-03-23 11:52:44,109 INFO - Statistics buffer: ‘C:\Terracotta\terracotta-2.7.3-ee\samples\spring\events\terracotta\client-statistics\spring\events\20090323115243515’. 2009-03-23 11:52:44,718 INFO - Connection successfully established to server at10.1.1.4:9510 Mar 23, 2009 11:52:44 AM org.apache.catalina.startup.Embedded initDirs SEVERE: Cannot find specified temporary folder at tomcat2\temp Mar 23, 2009 11:52:45 AM org.apache.coyote.http11.Http11AprProtocol init INFO: Initializing Coyote HTTP/1.1 on http-8082 Mar 23, 2009 11:52:45 AM org.apache.catalina.startup.Catalina load INFO: Initialization processed in 547 ms Mar 23, 2009 11:52:45 AM org.apache.catalina.core.StandardService start INFO: Starting service Catalina Mar 23, 2009 11:52:45 AM org.apache.catalina.core.StandardEngine start INFO: Starting Servlet Engine: Apache Tomcat/5.5.20 Mar 23, 2009 11:52:45 AM org.apache.catalina.core.StandardHost start INFO: XML validation disabled Mar 23, 2009 11:52:46 AM org.apache.catalina.core.ApplicationContext log INFO: Initializing Spring root WebApplicationContext Mar 23, 2009 11:52:46 AM org.springframework.web.context.ContextLoader initWebAp plicationContext INFO: Root WebApplicationContext: initialization started Mar 23, 2009 11:52:46 AM org.springframework.context.support.AbstractApplicationContext prepareRefresh INFO: Refreshing org.springframework.web.context.support.XmlWebApplicationContext@bfb588: display name [Root WebApplicationContext]; startup date [Mon Mar 23 11:52:46 IST 2009]; root of context hierarchy Mar 23, 2009 11:52:46 AM com.tcspring.ApplicationHelper getAppNameFrom INFO: Application name Tomcat.Catalina:localhost:/events Mar 23, 2009 11:52:47 AM org.springframework.beans.factory.xml.XmlBeanDefinitionReader loadBeanDefinitions INFO: Loading XML bean definitions from class path resource [demo/events/applicationContext.xml] Mar 23, 2009 11:52:47 AM com.tcspring.DistributableBeanFactoryMixin determineIfClustered INFO: 030C070E0E0E0F030A0706000E060100 Matching locations:[demo/events/applicationContext.xml] Mar 23, 2009 11:52:47 AM com.tcspring.DistributableBeanFactoryMixin determineIfClustered INFO: 030C070E0E0E0F030A0706000E060100 Context is distributed Mar 23, 2009 11:52:47 AM com.tcspring.ClassHierarchyWalker walkThroughClassHierarchy INFO: 030C070E0E0E0F030A0706000E060100 registering include for demo.events.MessageEvent Mar 23, 2009 11:52:47 AM com.tcspring.ClassHierarchyWalker walkThroughClassHierarchy INFO: 030C070E0E0E0F030A0706000E060100 registering include for java.lang.String Mar 23, 2009 11:52:47 AM org.springframework.context.support.AbstractApplicationContext obtainFreshBeanFactory INFO: Bean factory for application context [org.springframework.web.context.support.XmlWebApplicationContext@bfb588]: org.springframework.beans.factory.support.DefaultListableBeanFactory@185a2a8 Mar 23, 2009 11:52:47 AM org.springframework.beans.factory.support.DefaultListableBeanFactory preInstantiateSingletons INFO: Pre-instantiating singletons in org.springframework.beans.factory.support.DefaultListableBeanFactory@185a2a8: defining beans [eventProcessor]; root of factory hierarchy Mar 23, 2009 11:52:47 AM org.springframework.web.context.ContextLoader initWebApplicationContext INFO: Root WebApplicationContext: initialization completed in 1109 ms Mar 23, 2009 11:52:47 AM org.apache.coyote.http11.Http11AprProtocol start INFO: Starting Coyote HTTP/1.1 on http-8082 Mar 23, 2009 11:52:47 AM org.apache.catalina.startup.Catalina start INFO: Server startup in 2062 ms Mar 23, 2009 11:53:53 AM org.apache.catalina.core.ApplicationContext log INFO: Initializing Spring FrameworkServlet ‘events’ Mar 23, 2009 11:53:53 AM org.springframework.web.servlet.FrameworkServlet initServletBean INFO: FrameworkServlet ‘events’: initialization started Mar 23, 2009 11:53:53 AM org.springframework.context.support.AbstractApplicationContext prepareRefresh INFO: Refreshing org.springframework.web.context.support.XmlWebApplicationContext@139d980: display name [WebApplicationContext for namespace ‘events-servlet’];startup date [Mon Mar 23 11:53:53 IST 2009]; parent: org.springframework.web.context.support.XmlWebApplicationContext@bfb588 Mar 23, 2009 11:53:53 AM com.tcspring.ApplicationHelper getAppNameFrom INFO: Application name Tomcat.Catalina:localhost:/events Mar 23, 2009 11:53:53 AM org.springframework.beans.factory.xml.XmlBeanDefinitionReader loadBeanDefinitions INFO: Loading XML bean definitions from ServletContext resource [/WEB-INF/events-servlet.xml] Mar 23, 2009 11:53:54 AM com.tcspring.DistributableBeanFactoryMixin determineIfClustered INFO: 0602020A0C0F0308010F03050B070C0B Context is NOT distributed Mar 23, 2009 11:53:54 AM org.springframework.context.support.AbstractApplicationContext obtainFreshBeanFactory INFO: Bean factory for application context [org.springframework.web.context.support.XmlWebApplicationContext@139d980]: org.springframework.beans.factory.support.DefaultListableBeanFactory@a9ed1f Mar 23, 2009 11:53:54 AM org.springframework.beans.factory.support.DefaultListableBeanFactory preInstantiateSingletons INFO: Pre-instantiating singletons in org.springframework.beans.factory.support.DefaultListableBeanFactory@a9ed1f: defining beans [counterController,urlMapping,urlFilenameViewController,viewResolver,localeResolver,exceptionResolver]; parent: org.springframework.beans.factory.support.DefaultListableBeanFactory@185a2a8 Mar 23, 2009 11:53:54 AM org.springframework.web.servlet.FrameworkServlet initServletBean INFO: FrameworkServlet ‘events’: initialization completed in 984 ms Mar 23, 2009 11:54:04 AM com.tcspring.ApplicationContextEventProtocol multicastEvent INFO: 030C070E0E0E0F030A0706000E060100 Publishing event ApplicationContext to org.springframework.web.context.support.XmlWebApplicationContext@bfb588: display name [Root WebApplicationContext]; startup date [Mon Mar 23 11:52:46 IST 2009]; root of context hierarchy Thread[WorkerThread(dmi_stage,0),5,TC Thread Group] Mar 23, 2009 11:54:04 AM com.tcspring.ApplicationContextEventProtocol multicastEvent INFO: 030C070E0E0E0F030A0706000E060100 Publishing event ApplicationContext to org.springframework.web.context.support.XmlWebApplicationContext@bfb588: display name [Root WebApplicationContext]; startup date [Mon Mar 23 11:52:46 IST 2009]; root of context hierarchy Thread[WorkerThread(dmi_stage,0),5,TC Thread Group] Mar 23, 2009 11:54:24 AM com.tcspring.ApplicationContextEventProtocol multicastEvent INFO: 030C070E0E0E0F030A0706000E060100 Publishing event Tomcat 2 to org.springframework.web.context.support.XmlWebApplicationContext@bfb588: display name [RootWebApplicationContext]; startup date [Mon Mar 23 11:52:46 IST 2009]; root of context hierarchy Thread[http-8082-1,5,main]

The spring event demo logs on stable1 rev12200

Starting BootJarTool… 2009-03-23 11:56:19,984 INFO - Terracotta Enterprise 3.0.0-stable1, as of 20090318-130357 (Revision 3755-12200 by cruise@su10mo5 from 3.0) 2009-03-23 11:56:20,890 INFO - Configuration loaded from the file at ‘C:\Terracotta\terracotta-3.0.0-stable1-ee\samples\spring\events\tc-config.xml’. 2009-03-23 11:56:24,593 INFO - Product key found at: C:\Terracotta\terracotta-3.0.0-stable1-ee\product.key 2009-03-23 11:56:24,687 INFO - —————- Terracotta product key ————– License type = Trial License number = 1 Licensee = Terracotta Test Product = FX Max clients = 200 Capabilities = roots, sessions, TOC, server striping —————————————————— Creating boot JAR at ‘C:\Terracotta\terracotta-3.0.0-stable1-ee\bin..\bin..\lib\dso-boot\dso-boot-hotspot_win32_160_07.jar… Successfully created boot JAR file at ‘C:\Terracotta\terracotta-3.0.0-stable1-ee\bin..\bin..\lib\dso-boot\dso-boot-hotspot_win32_160_07.jar’. Starting Terracotta client… 2009-03-23 11:56:32,109 INFO - Terracotta Enterprise 3.0.0-stable1, as of 20090318-130357 (Revision 3755-12200 by cruise@su10mo5 from 3.0) 2009-03-23 11:56:32,703 INFO - Configuration loaded from the file at ‘C:\Terracotta\terracotta-3.0.0-stable1-ee\samples\spring\events\tc-config.xml’. 2009-03-23 11:56:33,140 INFO - Log file: ‘C:\Terracotta\terracotta-3.0.0-stable1-ee\samples\spring\events\terracotta\client-logs\spring\events\20090323115633109\terracotta-client.log’. 2009-03-23 11:56:34,375 INFO - Product key found at: C:\Terracotta\terracotta-3.0.0-stable1-ee\product.key 2009-03-23 11:56:34,453 INFO - —————- Terracotta product key ————– License type = Trial License number = 1 Licensee = Terracotta Test Product = FX Max clients = 200 Capabilities = roots, sessions, TOC, server striping —————————————————— 2009-03-23 11:56:36,984 INFO - Connection successfully established to server at10.1.1.4:9510 2009-03-23 11:56:37.812::INFO: Logging to STDERR via org.mortbay.log.StdErrLog2009-03-23 11:56:38.468::INFO: jetty-6.1.15 2009-03-23 11:56:38.515::INFO: Extract ./target/events.war to C:\DOCUME~1\hsingh\LOCALS~1\Temp\Jetty_0_0_0_0_8081_events.war__events__.jmlie6\webapp 2009-03-23 11:56:39.343:/events:INFO: Initializing Spring root WebApplicationContext Mar 23, 2009 11:56:39 AM org.springframework.web.context.ContextLoader initWebApplicationContext INFO: Root WebApplicationContext: initialization started Mar 23, 2009 11:56:40 AM org.springframework.context.support.AbstractApplicationContext prepareRefresh INFO: Refreshing org.springframework.web.context.support.XmlWebApplicationContext@f4388b: display name [Root WebApplicationContext]; startup date [Mon Mar 23 11:56:40 IST 2009]; root of context hierarchy Mar 23, 2009 11:56:40 AM com.tcspring.ApplicationHelper getAppNameFrom INFO: Application name Jetty.path:/events Mar 23, 2009 11:56:40 AM org.springframework.beans.factory.xml.XmlBeanDefinitionReader loadBeanDefinitions INFO: Loading XML bean definitions from class path resource [demo/events/applicationContext.xml] Mar 23, 2009 11:56:40 AM com.tcspring.DistributableBeanFactoryMixin determineIfClustered INFO: 030C070E0E0E0F030A0706000E060100 Matching locations:[demo/events/applicationContext.xml] Mar 23, 2009 11:56:40 AM com.tcspring.DistributableBeanFactoryMixin determineIfClustered INFO: 030C070E0E0E0F030A0706000E060100 Context is distributed Mar 23, 2009 11:56:40 AM com.tcspring.ClassHierarchyWalker walkThroughClassHierarchy INFO: 030C070E0E0E0F030A0706000E060100 registering include for demo.events.MessageEvent Mar 23, 2009 11:56:40 AM com.tcspring.ClassHierarchyWalker walkThroughClassHierarchy INFO: 030C070E0E0E0F030A0706000E060100 registering include for java.lang.String Mar 23, 2009 11:56:40 AM org.springframework.context.support.AbstractApplicationContext obtainFreshBeanFactory INFO: Bean factory for application context [org.springframework.web.context.support.XmlWebApplicationContext@f4388b]: org.springframework.beans.factory.support.DefaultListableBeanFactory@bf7a35 Mar 23, 2009 11:56:40 AM org.springframework.beans.factory.support.DefaultListableBeanFactory preInstantiateSingletons INFO: Pre-instantiating singletons in org.springframework.beans.factory.support.DefaultListableBeanFactory@bf7a35: defining beans [eventProcessor]; root of factory hierarchy Mar 23, 2009 11:56:41 AM org.springframework.web.context.ContextLoader initWebApplicationContext INFO: Root WebApplicationContext: initialization completed in 1610 ms 2009-03-23 11:56:41.328::INFO: Started [email protected]:8081 2009-03-23 11:57:09.703:/events:INFO: Initializing Spring FrameworkServlet ‘events’ Mar 23, 2009 11:57:09 AM org.springframework.web.servlet.FrameworkServlet initServletBean INFO: FrameworkServlet ‘events’: initialization started Mar 23, 2009 11:57:09 AM org.springframework.context.support.AbstractApplicationContext prepareRefresh INFO: Refreshing org.springframework.web.context.support.XmlWebApplicationContext@19f8120: display name [WebApplicationContext for namespace ‘events-servlet’]; startup date [Mon Mar 23 11:57:09 IST 2009]; parent: org.springframework.web.context.support.XmlWebApplicationContext@f4388b Mar 23, 2009 11:57:09 AM com.tcspring.ApplicationHelper getAppNameFrom INFO: Application name Jetty.path:/events Mar 23, 2009 11:57:09 AM org.springframework.beans.factory.xml.XmlBeanDefinitionReader loadBeanDefinitions INFO: Loading XML bean definitions from ServletContext resource [/WEB-INF/events-servlet.xml] Mar 23, 2009 11:57:09 AM com.tcspring.DistributableBeanFactoryMixin determineIfClustered INFO: 0602020A0C0F0308010F03050B070C0B Context is NOT distributed Mar 23, 2009 11:57:09 AM org.springframework.context.support.AbstractApplicationContext obtainFreshBeanFactory INFO: Bean factory for application context [org.springframework.web.context.support.XmlWebApplicationContext@19f8120]: org.springframework.beans.factory.support.DefaultListableBeanFactory@4dc002 Mar 23, 2009 11:57:09 AM org.springframework.beans.factory.support.DefaultListableBeanFactory preInstantiateSingletons INFO: Pre-instantiating singletons in org.springframework.beans.factory.support.DefaultListableBeanFactory@4dc002: defining beans [counterController,urlMapping,urlFilenameViewController,viewResolver,localeResolver,exceptionResolver]; parent: org.springframework.beans.factory.support.DefaultListableBeanFactory@bf7a35 Mar 23, 2009 11:57:10 AM org.springframework.web.servlet.FrameworkServlet initServletBean INFO: FrameworkServlet ‘events’: initialization completed in 406 ms

No “Publishing event” logs are printed now.