java的Exception方法printStackTrace()不打印日志？

背景

• 记录java的Sytem.out与System.err区别

• e.printStackTrace()与Sytem.err的关系

• 在生产环境在捕获到异常的时候调用e.printStackTrace()，然后又立即调用log.info()打印日志，可能会出现什么问题？是顺序输出日志的吗？

• e.printStackTrace()一定会打印日志吗？

过程

• 现象

1. 测试代码

public class JsonTest {
    public static void main(String[] args) {

        for (int i = 0; i < 20 ; i++) {
            try{
                parseJson();
            }catch (Exception e){
                System.out.println("Loop:"+(i+1));
                e.printStackTrace();
            }
        }
    }

    public static Message parseJson() {
        String aa = "{\"rspCode\":\"0000\",\"rspDesc\":\"操作成功\",\"uuid\":\"ec6865ca-7a1d-41ad-a9f2-23b792417f1\",\"body\":\"{\\\"id\\\":\\\"17610522126516\\\",\\\"preNumber\\\":\\\"1760032825\\\",\\\"shortUrl\\\":\\\"https://uc.g.cn/AkxXrTi9\\\"}\"}";
        Message jsonObject = JSON.parseObject(aa, Message.class);
        return jsonObject;
    }
}

1. 测试结果

2. 结果分析：按照我们的思路是打印循环标识Loop：index然后打印堆栈，但是实际测试结果并不是按照顺序输出的。

• Sytem.out与System.err区别？ 是不同的流
• e.printStackTrace() 打印的时候加锁了吗？ 加锁了的
• e.printStackTrace()用的是什么？System.err
• 实现e.printStackTrace(）和System.out顺序输出内容

1. 代码

public class JsonTest {
    public static void main(String[] args) {

        for (int i = 0; i < 20 ; i++) {
            try{
                parseJson();
            }catch (Exception e){
                System.out.println("Loop:"+(i+1));
                e.printStackTrace(System.out);
            }
        }
    }

    public static Message parseJson() {
        String aa = "{\"rspCode\":\"0000\",\"rspDesc\":\"操作成功\",\"uuid\":\"ec6865ca-7a1d-41ad-a9f2-23b792417f1\",\"body\":\"{\\\"id\\\":\\\"17610522126516\\\",\\\"preNumber\\\":\\\"1760032825\\\",\\\"shortUrl\\\":\\\"https://uc.g.cn/AkxXrTi9\\\"}\"}";
        Message jsonObject = JSON.parseObject(aa, Message.class);
        return jsonObject;
    }
}

• 测试结果：完全按照顺序进行输出。

• 在生产环境在捕获到异常的时候调用e.printStackTrace()，然后又立即调用log.info()打印日志，可能会出现什么问题？

  堆栈信息和日志内容，很大一部分可能是不会顺序输出的。

• e.printStackTrace()一定会打印日志吗？

  不一定。jvm进行了优化，如果出现非常频繁打印同一个堆栈信息的情况，后续将不会再打印堆栈信息了。

小结

• System.err和System.out是不同的流

• System.err和System.out在打印的时候都加锁了的。但是加的都是自己本身类型的锁（一个是err类型，另一个是out类型）。

• 想要顺序输出e.printStackTrace()和System.out的内容，则需要修改如下：e.printStackTrace(System.out)即可，这样就是加的是同一把锁了。

• 注意事项

1. 生产环境如果出现e.printStackTrace和log.info()的情况，日志很大一部分可能是不会顺序输出的。

2. 如果是定时任务中出现异常，导致频繁执行e.printStackTrace()方法的话，jvm做了优化，刚开始将打印堆栈信息，后续就不再打印堆栈信息了，因此需要去日志文件的开始处找堆栈信息，然后定位问题。