[
https://issues.apache.org/jira/browse/JAMES-3248?page=com.atlassian.jira.plugin.system.issuetabpanels:comment-tabpanel&focusedCommentId=17140210#comment-17140210
]
David Leangen commented on JAMES-3248:
--------------------------------------
Here is the current log output, trimmed for brevity.
{noformat}
james_1 | 04:25:07,701 |-INFO in ch.qos.logback.classic.LoggerContext[default]
- Found resource [/opt/apache-james/james-server/conf/logback.xml] at
[file:/opt/apache-james/james-server/conf/logback.xml]
james_1 | 04:25:08,034 |-INFO in
ch.qos.logback.classic.joran.action.ConfigurationAction - debug attribute not
set
james_1 | 04:25:08,043 |-INFO in
ch.qos.logback.classic.joran.action.LoggerContextListenerAction - Adding
LoggerContextListener of type
[ch.qos.logback.classic.jul.LevelChangePropagator] to the object stack
james_1 | 04:25:08,121 |-INFO in
ch.qos.logback.classic.jul.LevelChangePropagator@53aad5d5 - Propagating DEBUG
level on Logger[ROOT] onto the JUL framework
james_1 | 04:25:08,122 |-INFO in
ch.qos.logback.classic.joran.action.LoggerContextListenerAction - Starting
LoggerContextListener
james_1 | 04:25:08,122 |-INFO in
ch.qos.logback.core.joran.action.AppenderAction - About to instantiate appender
of type [ch.qos.logback.core.ConsoleAppender]
james_1 | 04:25:08,129 |-INFO in
ch.qos.logback.core.joran.action.AppenderAction - Naming appender as [CONSOLE]
james_1 | 04:25:08,135 |-INFO in
ch.qos.logback.core.joran.action.NestedComplexPropertyIA - Assuming default
type [ch.qos.logback.classic.encoder.PatternLayoutEncoder] for [encoder]
property
james_1 | 04:25:08,144 |-WARN in
ch.qos.logback.classic.encoder.PatternLayoutEncoder@46fa7c39 - As of version
1.2.0 "immediateFlush" property should be set within the enclosing Appender.
james_1 | 04:25:08,144 |-WARN in
ch.qos.logback.classic.encoder.PatternLayoutEncoder@46fa7c39 - Please move
"immediateFlush" property into the enclosing appender.
james_1 | 04:25:08,253 |-WARN in
ch.qos.logback.classic.encoder.PatternLayoutEncoder@46fa7c39 - Setting the
"immediateFlush" property of the enclosing appender to false
james_1 | 04:25:08,254 |-INFO in
ch.qos.logback.core.joran.action.AppenderAction - About to instantiate appender
of type [ch.qos.logback.core.rolling.RollingFileAppender]
james_1 | 04:25:08,268 |-INFO in
ch.qos.logback.core.joran.action.AppenderAction - Naming appender as [LOG_FILE]
james_1 | 04:25:08,282 |-INFO in
ch.qos.logback.core.rolling.FixedWindowRollingPolicy@1fb700ee - Will use gz
compression
james_1 | 04:25:08,292 |-INFO in
ch.qos.logback.core.joran.action.NestedComplexPropertyIA - Assuming default
type [ch.qos.logback.classic.encoder.PatternLayoutEncoder] for [encoder]
property
james_1 | 04:25:08,293 |-WARN in
ch.qos.logback.classic.encoder.PatternLayoutEncoder@4f67eb2a - As of version
1.2.0 "immediateFlush" property should be set within the enclosing Appender.
james_1 | 04:25:08,293 |-WARN in
ch.qos.logback.classic.encoder.PatternLayoutEncoder@4f67eb2a - Please move
"immediateFlush" property into the enclosing appender.
james_1 | 04:25:08,294 |-WARN in
ch.qos.logback.classic.encoder.PatternLayoutEncoder@4f67eb2a - Setting the
"immediateFlush" property of the enclosing appender to false
james_1 | 04:25:08,294 |-INFO in
ch.qos.logback.core.rolling.RollingFileAppender[LOG_FILE] - Active log file
name: logs/james.log
james_1 | 04:25:08,294 |-INFO in
ch.qos.logback.core.rolling.RollingFileAppender[LOG_FILE] - File property is
set to [logs/james.log]
james_1 | 04:25:08,296 |-INFO in
ch.qos.logback.classic.joran.action.RootLoggerAction - Setting level of ROOT
logger to WARN
james_1 | 04:25:08,296 |-INFO in
ch.qos.logback.classic.jul.LevelChangePropagator@53aad5d5 - Propagating WARN
level on Logger[ROOT] onto the JUL framework
james_1 | 04:25:08,297 |-INFO in
ch.qos.logback.core.joran.action.AppenderRefAction - Attaching appender named
[CONSOLE] to Logger[ROOT]
james_1 | 04:25:08,298 |-INFO in
ch.qos.logback.core.joran.action.AppenderRefAction - Attaching appender named
[LOG_FILE] to Logger[ROOT]
james_1 | 04:25:08,298 |-INFO in
ch.qos.logback.classic.joran.action.ConfigurationAction - End of configuration.
james_1 | 04:25:08,299 |-INFO in
ch.qos.logback.classic.joran.JoranConfigurator@4a668b6e - Registering current
configuration as safe fallback point
james_1 |
james_1 | WARNING: An illegal reflective access operation has occurred
james_1 | WARNING: Illegal reflective access by
com.google.inject.internal.cglib.core.$ReflectUtils$1
(file:/opt/apache-james/james-server/lib/guice-4.2.2.jar) to method
java.lang.ClassLoader.defineClass(java.lang.String,byte[],int,int,java.security.ProtectionDomain)
james_1 | WARNING: Please consider reporting this to the maintainers of
com.google.inject.internal.cglib.core.$ReflectUtils$1
james_1 | WARNING: Use --illegal-access=warn to enable warnings of further
illegal reflective access operations
james_1 | WARNING: All illegal access operations will be denied in a future
release
james_1 | 50 Global WARN [main] openjpa.Runtime - Could not create the
optional validation provider. Reason returned: "A default ValidatorFactory
could not be created."
james_1 | 04:25:12.544 [WARN ] o.a.j.s.c.c.FileConfigurationProvider - Unable
to locate configuration file mailrepositorystore.xml, assuming empty
configuration
james_1 | 04:25:12.568 [WARN ] o.a.j.m.s.MailStoreRepositoryModule - Empty
MailRepository store configuration supplied. Defaulting to default
configuration for this product
james_1 | 04:25:13.144 [WARN ] o.a.a.b.BrokerService - Memory Usage for the
Broker (1024mb) is more than the maximum available for the JVM: 986 mb -
resetting to 70% of maximum available: 690 mb
james_1 | 04:25:13.537 [WARN ] o.a.a.b.BrokerService - Store limit is 102400
mb (current store usage is 0 mb). The data directory:
/opt/apache-james/james-server/var/store/activemq/brokers/KahaDB only has 49438
mb of usable space. - resetting to maximum available disk space: 49438 mb
james_1 | 04:25:13.539 [WARN ] o.a.a.b.BrokerService - Temporary Store limit
is 51200 mb (current store usage is 0 mb). The data directory:
/opt/apache-james/james-server/var/store/activemq/brokers only has 49437 mb of
usable space. - resetting to maximum available disk space: 49437 mb
james_1 | 04:25:13.726 [WARN ] o.a.j.s.c.c.FileConfigurationProvider - Unable
to locate configuration file domainlist.xml, assuming empty configuration
james_1 | 1365 Global INFO [main] openjpa.Runtime - Starting OpenJPA 3.1.0
james_1 | 1469 Global INFO [main] openjpa.jdbc.JDBC - Using dictionary
class "org.apache.openjpa.jdbc.sql.DerbyDictionary".
james_1 | 3171 Global INFO [main] openjpa.jdbc.JDBC - Connected to Apache
Derby version 10.10 using JDBC driver Apache Derby Embedded JDBC Driver version
10.14.2.0 - (1828579).
james_1 | 04:25:17.850 [WARN ] o.a.j.s.c.c.FileConfigurationProvider - Unable
to locate configuration file listeners.xml, assuming empty configuration
james_1 | 04:25:19.698 [WARN ] o.a.j.m.s.JMXServerModule - Could not locate
configuration file for JMX. Defaults to rmi://127.0.0.1:9999
james_1 | 04:25:19.717 [WARN ] o.a.j.s.c.c.FileConfigurationProvider - Unable
to locate configuration file dnsservice.xml, assuming empty configuration
james_1 | 04:25:20.314 [WARN ] o.a.j.d.d.DNSJavaService - Error determining
result
james_1 | java.lang.IllegalStateException: Lookup of localhost A isn't done
<snip>
james_1 | 04:25:20.315 [ERROR] o.a.j.d.l.AbstractDomainList - Cannot get IP
address(es) for Domain : localhost
james_1 | 04:25:20.327 [WARN ] o.a.j.s.c.c.FileConfigurationProvider - Unable
to locate configuration file usersrepository.xml, assuming empty configuration
james_1 | 04:25:20.330 [WARN ] o.a.j.s.c.c.FileConfigurationProvider - Unable
to locate configuration file recipientrewritetable.xml, assuming empty
configuration
james_1 | 04:25:20.572 [WARN ] o.a.j.d.d.DNSJavaService - Error determining
result
james_1 | java.lang.IllegalStateException: Lookup of localhost A isn't done
<snip>
james_1 | 04:25:20.573 [ERROR] o.a.j.d.l.AbstractDomainList - Cannot get IP
address(es) for Domain : localhost
james_1 | 04:25:20.574 [WARN ] o.a.j.m.i.JamesMailetContext - The specified
postmaster address ( [email protected] ) is not a local address. This
is not necessarily a problem, but it does mean that emails addressed to the
postmaster will be routed to another server. For some configurations this may
cause problems.
james_1 | 04:25:21.282 [WARN ] o.a.j.t.m.r.d.DelaysAndMaxRetry - maxRetries is
larger than total number of attempts specified. Increasing last delayTime with
22 attempts
james_1 | 04:25:21.285 [WARN ] o.a.j.t.m.r.d.DelaysAndMaxRetry - Delay of 8
minutes 20 seconds is now attempted: 1 times
james_1 | 04:25:21.596 [ERROR] o.a.j.m.l.AbstractStateMailetProcessor - Unable
to init mailet ro.ieugen.sample.mailets.LogAndDoNothingMailet
james_1 | java.lang.ClassNotFoundException:
ro.ieugen.sample.mailets.LogAndDoNothingMailet
<snip>
{noformat}
I may have over-snipped, but that is already quite a lot to deal with.
> Eliminate log warnings
> ----------------------
>
> Key: JAMES-3248
> URL: https://issues.apache.org/jira/browse/JAMES-3248
> Project: James Server
> Issue Type: Sub-task
> Reporter: David Leangen
> Priority: Major
>
> Warnings generated in the logs should be ideally completely eliminated, as it
> creates anxiety for the Basic Operator and is bad for mental health. ;)
> I will post the warnings here one by one so we can figure out how to deal
> with each of them (simple resolution, or something that requires a separate
> issue).
--
This message was sent by Atlassian Jira
(v8.3.4#803005)
---------------------------------------------------------------------
To unsubscribe, e-mail: [email protected]
For additional commands, e-mail: [email protected]
