builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-056 starttime: 1503445659.44 results: success (0) revision: 80fafbaaf8484104018976c2a0442c91805d3554 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-08-22 16:47:39.439036) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-08-22 16:47:39.439545) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-08-22 16:47:39.439815) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-08-22 16:47:39.455691) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-22 16:47:39.456010) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-08-22 16:47:39-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 46.4M=0s 2017-08-22 16:47:39 (46.4 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.142541 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-22 16:47:39.614653) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-08-22 16:47:39.614965) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015484 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-08-22 16:47:39.664323) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-08-22 16:47:39.664662) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 80fafbaaf8484104018976c2a0442c91805d3554 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev 80fafbaaf8484104018976c2a0442c91805d3554 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-08-22 16:47:39,931 truncating revision to first 12 chars 2017-08-22 16:47:39,931 Setting DEBUG logging. 2017-08-22 16:47:39,931 attempt 1/10 2017-08-22 16:47:39,931 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/80fafbaaf848?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-08-22 16:47:40,789 unpacking tar archive at: mozilla-central-80fafbaaf848/testing/mozharness/ program finished with exit code 0 elapsedTime=1.186075 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-08-22 16:47:40.868439) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-08-22 16:47:40.868765) ========= script_repo_revision: 80fafbaaf8484104018976c2a0442c91805d3554 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-08-22 16:47:40.869166) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-08-22 16:47:40.869446) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-08-22 16:47:40.880379) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 51 secs) (at 2017-08-22 16:47:40.880750) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 16:47:41 INFO - MultiFileLogger online at 20170822 16:47:41 in /builds/slave/test 16:47:41 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 16:47:41 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 16:47:41 INFO - {'append_to_log': False, 16:47:41 INFO - 'base_work_dir': '/builds/slave/test', 16:47:41 INFO - 'blob_upload_branch': 'Firefox', 16:47:41 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 16:47:41 INFO - 'branch': 'Firefox', 16:47:41 INFO - 'buildbot_json_path': 'buildprops.json', 16:47:41 INFO - 'code_coverage': False, 16:47:41 INFO - 'config_files': ('talos/linux_config.py',), 16:47:41 INFO - 'default_actions': ('clobber', 16:47:41 INFO - 'read-buildbot-config', 16:47:41 INFO - 'download-and-extract', 16:47:41 INFO - 'populate-webroot', 16:47:41 INFO - 'create-virtualenv', 16:47:41 INFO - 'install', 16:47:41 INFO - 'setup-mitmproxy', 16:47:41 INFO - 'run-tests'), 16:47:41 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 16:47:41 INFO - 'disable_ccov_upload': False, 16:47:41 INFO - 'download_minidump_stackwalk': True, 16:47:41 INFO - 'download_symbols': 'ondemand', 16:47:41 INFO - 'enable_stylo': False, 16:47:41 INFO - 'enable_webrender': False, 16:47:41 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 16:47:41 INFO - 'tooltool.py': '/tools/tooltool.py', 16:47:41 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 16:47:41 INFO - '/tools/misc-python/virtualenv.py')}, 16:47:41 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 16:47:41 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 16:47:41 INFO - 'gecko_profile': False, 16:47:41 INFO - 'gecko_profile_interval': 0, 16:47:41 INFO - 'installer_path': 'installer.exe', 16:47:41 INFO - 'log_level': 'info', 16:47:41 INFO - 'log_name': 'talos', 16:47:41 INFO - 'log_to_console': True, 16:47:41 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 16:47:41 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 16:47:41 INFO - 'opt_config_files': (), 16:47:41 INFO - 'pip_index': False, 16:47:41 INFO - 'suite': 'dromaeojs-e10s', 16:47:41 INFO - 'system_bits': '32', 16:47:41 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 16:47:41 INFO - 'title': 'talos-linux64-ix-056', 16:47:41 INFO - 'tooltool_cache': '/builds/tooltool_cache', 16:47:41 INFO - 'use_talos_json': True, 16:47:41 INFO - 'verify': 'False', 16:47:41 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 16:47:41 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 16:47:41 INFO - 'work_dir': 'build'} 16:47:41 INFO - [mozharness: 2017-08-22 23:47:41.286099Z] Running clobber step. 16:47:41 INFO - Running pre-action listener: _resource_record_pre_action 16:47:41 INFO - Running main action method: clobber 16:47:41 INFO - rmtree: /builds/slave/test/build 16:47:41 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 16:47:42 INFO - Running post-action listener: _resource_record_post_action 16:47:42 INFO - [mozharness: 2017-08-22 23:47:42.305457Z] Finished clobber step (success) 16:47:42 INFO - [mozharness: 2017-08-22 23:47:42.305553Z] Running read-buildbot-config step. 16:47:42 INFO - Running pre-action listener: _resource_record_pre_action 16:47:42 INFO - Running main action method: read_buildbot_config 16:47:42 INFO - Using buildbot properties: 16:47:42 INFO - { 16:47:42 INFO - "project": "", 16:47:42 INFO - "product": "firefox", 16:47:42 INFO - "who": "kwierso@gmail.com", 16:47:42 INFO - "installer_path": "public/build/target.tar.bz2", 16:47:42 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 16:47:42 INFO - "repository": "https://hg.mozilla.org/mozilla-central", 16:47:42 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs-e10s", 16:47:42 INFO - "stage_platform": "linux64-pgo", 16:47:42 INFO - "basedir": "/builds/slave/test", 16:47:42 INFO - "buildnumber": 136, 16:47:42 INFO - "platform": "ubuntu64_hw", 16:47:42 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 16:47:42 INFO - "slavebuilddir": "test", 16:47:42 INFO - "taskId": "funyYiieQnK7m8K0uWhrVA", 16:47:42 INFO - "branch": "mozilla-central", 16:47:42 INFO - "script_repo_revision": "production", 16:47:42 INFO - "revision": "80fafbaaf8484104018976c2a0442c91805d3554", 16:47:42 INFO - "slavename": "talos-linux64-ix-056", 16:47:42 INFO - "repo_path": "mozilla-central" 16:47:42 INFO - } 16:47:42 INFO - Finding installer, test and symbols from parent task. 16:47:42 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/funyYiieQnK7m8K0uWhrVA'}, attempt #1 16:47:42 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/funyYiieQnK7m8K0uWhrVA'}, attempt #1 16:47:43 INFO - Task dependencies: LYBzTNi1T0ybIZwpNEaiNg 16:47:43 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg'}, attempt #1 16:47:43 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.tar.bz2 16:47:43 INFO - Set test_packages_url: https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.test_packages.json 16:47:43 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.crashreporter-symbols.zip 16:47:43 INFO - Running post-action listener: _resource_record_post_action 16:47:43 INFO - [mozharness: 2017-08-22 23:47:43.660168Z] Finished read-buildbot-config step (success) 16:47:43 INFO - [mozharness: 2017-08-22 23:47:43.660386Z] Running download-and-extract step. 16:47:43 INFO - Running pre-action listener: _resource_record_pre_action 16:47:43 INFO - Running main action method: download_and_extract 16:47:43 INFO - mkdir: /builds/slave/test/build/tests 16:47:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:47:43 INFO - trying https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.test_packages.json 16:47:43 INFO - Downloading https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 16:47:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 16:47:44 INFO - Downloaded 989 bytes. 16:47:44 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 16:47:44 INFO - Using the following test package requirements: 16:47:44 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 16:47:44 INFO - u'common': [u'target.common.tests.zip'], 16:47:44 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 16:47:44 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 16:47:44 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 16:47:44 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 16:47:44 INFO - u'mozbase': [u'target.common.tests.zip'], 16:47:44 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 16:47:44 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 16:47:44 INFO - u'web-platform': [u'target.common.tests.zip', 16:47:44 INFO - u'target.web-platform.tests.tar.gz'], 16:47:44 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 16:47:44 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 16:47:44 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.common.tests.zip 16:47:44 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.common.tests.zip'}, attempt #1 16:47:44 INFO - Fetch https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.common.tests.zip into memory 16:47:45 INFO - Content-Length response header: 55745062 16:47:45 INFO - Bytes received: 55745062 16:47:56 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 16:47:56 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.common.tests.zip 16:47:56 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.common.tests.zip'}, attempt #1 16:47:56 INFO - Fetch https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.common.tests.zip into memory 16:47:57 INFO - Content-Length response header: 55745062 16:47:57 INFO - Bytes received: 55745062 16:48:09 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.talos.tests.zip 16:48:09 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.talos.tests.zip'}, attempt #1 16:48:09 INFO - Fetch https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.talos.tests.zip into memory 16:48:10 INFO - Content-Length response header: 14496256 16:48:10 INFO - Bytes received: 14496256 16:48:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:10 INFO - trying https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.tar.bz2 16:48:10 INFO - Downloading https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 16:48:10 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 16:48:11 INFO - Downloaded 62496648 bytes. 16:48:11 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.tar.bz2 16:48:11 INFO - mkdir: /builds/slave/test/properties 16:48:11 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 16:48:11 INFO - Writing to file /builds/slave/test/properties/build_url 16:48:11 INFO - Contents: 16:48:11 INFO - build_url:https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.tar.bz2 16:48:11 INFO - Running post-action listener: _resource_record_post_action 16:48:11 INFO - Running post-action listener: find_tests_for_verification 16:48:11 INFO - Running post-action listener: set_extra_try_arguments 16:48:11 INFO - [mozharness: 2017-08-22 23:48:11.830646Z] Finished download-and-extract step (success) 16:48:11 INFO - [mozharness: 2017-08-22 23:48:11.830743Z] Running populate-webroot step. 16:48:11 INFO - Running pre-action listener: _resource_record_pre_action 16:48:11 INFO - Running main action method: populate_webroot 16:48:11 INFO - {'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 16:48:11 INFO - 'chromez-stylo-e10s': {'talos_options': ['--stylo'], 16:48:11 INFO - 'tests': ['tresize', 'tcanvasmark']}, 16:48:11 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 16:48:11 INFO - 'dromaeojs-stylo-e10s': {'talos_options': ['--stylo'], 16:48:11 INFO - 'tests': ['dromaeo_css', 'kraken']}, 16:48:11 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 16:48:11 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:48:11 INFO - 'g1-stylo-e10s': {'pagesets_name': 'tp5n.zip', 16:48:11 INFO - 'talos_options': ['--stylo'], 16:48:11 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:48:11 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 16:48:11 INFO - 'tests': ['damp', 'tps']}, 16:48:11 INFO - 'g2-stylo-e10s': {'pagesets_name': 'tp5n.zip', 16:48:11 INFO - 'talos_options': ['--stylo'], 16:48:11 INFO - 'tests': ['damp', 'tps']}, 16:48:11 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 16:48:11 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 16:48:11 INFO - 'g4-stylo-e10s': {'talos_options': ['--stylo'], 16:48:11 INFO - 'tests': ['basic_compositor_video', 'glvideo']}, 16:48:11 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 16:48:11 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 16:48:11 INFO - 'g5-stylo-e10s': {'pagesets_name': 'tp5n.zip', 16:48:11 INFO - 'talos_options': ['--stylo'], 16:48:11 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 16:48:11 INFO - 'other-e10s': {'tests': ['a11yr', 16:48:11 INFO - 'ts_paint', 16:48:11 INFO - 'tpaint', 16:48:11 INFO - 'sessionrestore', 16:48:11 INFO - 'sessionrestore_many_windows', 16:48:11 INFO - 'sessionrestore_no_auto_restore', 16:48:11 INFO - 'tabpaint']}, 16:48:11 INFO - 'other-stylo-e10s': {'talos_options': ['--stylo'], 16:48:11 INFO - 'tests': ['a11yr', 16:48:11 INFO - 'ts_paint', 16:48:11 INFO - 'tpaint', 16:48:11 INFO - 'sessionrestore', 16:48:11 INFO - 'sessionrestore_many_windows', 16:48:11 INFO - 'sessionrestore_no_auto_restore', 16:48:11 INFO - 'tabpaint']}, 16:48:11 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 16:48:11 INFO - 'perf-reftest-singletons-e10s': {'tests': ['bloom_basic_singleton']}, 16:48:11 INFO - 'perf-reftest-singletons-stylo-e10s': {'talos_options': ['--stylo'], 16:48:11 INFO - 'tests': ['bloom_basic_singleton']}, 16:48:11 INFO - 'perf-reftest-stylo-e10s': {'talos_options': ['--stylo'], 16:48:11 INFO - 'tests': ['bloom_basic']}, 16:48:11 INFO - 'svgr-e10s': {'tests': ['tsvgx', 16:48:11 INFO - 'tsvgr_opacity', 16:48:11 INFO - 'tart', 16:48:11 INFO - 'tscrollx', 16:48:11 INFO - 'tsvg_static']}, 16:48:11 INFO - 'svgr-stylo-e10s': {'talos_options': ['--stylo'], 16:48:11 INFO - 'tests': ['tsvgx', 16:48:11 INFO - 'tsvgr_opacity', 16:48:11 INFO - 'tart', 16:48:11 INFO - 'tscrollx', 16:48:11 INFO - 'tsvg_static']}, 16:48:11 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 16:48:11 INFO - 'tp5o-stylo-e10s': {'pagesets_name': 'tp5n.zip', 16:48:11 INFO - 'talos_options': ['--stylo'], 16:48:11 INFO - 'tests': ['tp5o']}, 16:48:11 INFO - 'tp6-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 16:48:11 INFO - 'talos_options': ['--mitmproxy', 16:48:11 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 16:48:11 INFO - '--firstNonBlankPaint'], 16:48:11 INFO - 'tests': ['tp6_google', 16:48:11 INFO - 'tp6_youtube', 16:48:11 INFO - 'tp6_amazon', 16:48:11 INFO - 'tp6_facebook']}, 16:48:11 INFO - 'tp6-stylo-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 16:48:11 INFO - 'talos_options': ['--stylo', 16:48:11 INFO - '--mitmproxy', 16:48:11 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 16:48:11 INFO - '--firstNonBlankPaint'], 16:48:11 INFO - 'tests': ['tp6_google', 16:48:11 INFO - 'tp6_youtube', 16:48:11 INFO - 'tp6_amazon', 16:48:11 INFO - 'tp6_facebook']}, 16:48:11 INFO - 'tp6-stylo-threads-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 16:48:11 INFO - 'talos_options': ['--stylo', 16:48:11 INFO - '--stylo-threads=1', 16:48:11 INFO - '--mitmproxy', 16:48:11 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 16:48:11 INFO - '--firstNonBlankPaint'], 16:48:11 INFO - 'tests': ['tp6_google', 16:48:11 INFO - 'tp6_youtube', 16:48:11 INFO - 'tp6_amazon', 16:48:11 INFO - 'tp6_facebook']}, 16:48:11 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 16:48:11 INFO - 'talos_options': ['--xperf_path', 16:48:11 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:48:11 INFO - 'tests': ['tp5n']}, 16:48:11 INFO - 'xperf-stylo-e10s': {'pagesets_name': 'tp5n.zip', 16:48:11 INFO - 'talos_options': ['--stylo', 16:48:11 INFO - '--xperf_path', 16:48:11 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:48:11 INFO - 'tests': ['tp5n']}}} 16:48:11 INFO - Running post-action listener: _resource_record_post_action 16:48:11 INFO - [mozharness: 2017-08-22 23:48:11.845003Z] Finished populate-webroot step (success) 16:48:11 INFO - [mozharness: 2017-08-22 23:48:11.845112Z] Running create-virtualenv step. 16:48:11 INFO - Running pre-action listener: _resource_record_pre_action 16:48:11 INFO - Running main action method: create_virtualenv 16:48:11 INFO - Creating virtualenv /builds/slave/test/build/venv 16:48:11 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 16:48:11 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 16:48:11 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 16:48:11 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 16:48:11 INFO - Using real prefix '/usr' 16:48:11 INFO - New python executable in /builds/slave/test/build/venv/bin/python 16:48:12 INFO - Installing distribute.............................................................................................................................................................................................done. 16:48:14 INFO - Installing pip.................done. 16:48:14 INFO - Return code: 0 16:48:14 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 16:48:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 16:48:14 INFO - Reading from file tmpfile_stdout 16:48:14 INFO - Output received: 16:48:14 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 16:48:14 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 16:48:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:48:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:48:14 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1de21f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fada80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2150f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214e130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214f030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x214f4c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:48:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 16:48:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 16:48:14 INFO - Using env: {'DISPLAY': ':0', 16:48:14 INFO - 'HOME': '/home/cltbld', 16:48:14 INFO - 'LANG': 'en_US.UTF-8', 16:48:14 INFO - 'LANGUAGE': 'en_US:en', 16:48:14 INFO - 'LOGNAME': 'cltbld', 16:48:14 INFO - 'MAIL': '/var/mail/cltbld', 16:48:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:48:14 INFO - 'MOZ_NO_REMOTE': '1', 16:48:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:48:14 INFO - 'NO_EM_RESTART': '1', 16:48:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:48:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:48:14 INFO - 'PWD': '/builds/slave/test', 16:48:14 INFO - 'SHELL': '/bin/bash', 16:48:14 INFO - 'SHLVL': '1', 16:48:14 INFO - 'TERM': 'linux', 16:48:14 INFO - 'TMOUT': '86400', 16:48:14 INFO - 'USER': 'cltbld', 16:48:14 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 16:48:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:48:14 INFO - '_': '/tools/buildbot/bin/python'} 16:48:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:48:14 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 16:48:14 INFO - Cleaning up... 16:48:14 INFO - Return code: 0 16:48:14 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 16:48:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:48:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:48:14 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1de21f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fada80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2150f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214e130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214f030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x214f4c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:48:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 16:48:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 16:48:14 INFO - Using env: {'DISPLAY': ':0', 16:48:14 INFO - 'HOME': '/home/cltbld', 16:48:14 INFO - 'LANG': 'en_US.UTF-8', 16:48:14 INFO - 'LANGUAGE': 'en_US:en', 16:48:14 INFO - 'LOGNAME': 'cltbld', 16:48:14 INFO - 'MAIL': '/var/mail/cltbld', 16:48:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:48:14 INFO - 'MOZ_NO_REMOTE': '1', 16:48:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:48:14 INFO - 'NO_EM_RESTART': '1', 16:48:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:48:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:48:14 INFO - 'PWD': '/builds/slave/test', 16:48:14 INFO - 'SHELL': '/bin/bash', 16:48:14 INFO - 'SHLVL': '1', 16:48:14 INFO - 'TERM': 'linux', 16:48:14 INFO - 'TMOUT': '86400', 16:48:14 INFO - 'USER': 'cltbld', 16:48:14 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 16:48:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:48:14 INFO - '_': '/tools/buildbot/bin/python'} 16:48:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:48:15 INFO - Downloading/unpacking psutil>=3.1.1 16:48:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:48:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:48:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:48:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:48:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 16:48:16 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:48:16 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:48:16 INFO - Installing collected packages: psutil 16:48:16 INFO - Running setup.py install for psutil 16:48:16 INFO - building 'psutil._psutil_linux' extension 16:48:16 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 16:48:16 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 16:48:16 INFO - building 'psutil._psutil_posix' extension 16:48:16 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 16:48:16 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 16:48:16 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:48:16 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:48:16 INFO - Successfully installed psutil 16:48:16 INFO - Cleaning up... 16:48:16 INFO - Return code: 0 16:48:16 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 16:48:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:48:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:48:16 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1de21f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fada80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2150f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214e130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214f030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x214f4c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:48:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 16:48:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 16:48:16 INFO - Using env: {'DISPLAY': ':0', 16:48:16 INFO - 'HOME': '/home/cltbld', 16:48:16 INFO - 'LANG': 'en_US.UTF-8', 16:48:16 INFO - 'LANGUAGE': 'en_US:en', 16:48:16 INFO - 'LOGNAME': 'cltbld', 16:48:16 INFO - 'MAIL': '/var/mail/cltbld', 16:48:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:48:16 INFO - 'MOZ_NO_REMOTE': '1', 16:48:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:48:16 INFO - 'NO_EM_RESTART': '1', 16:48:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:48:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:48:16 INFO - 'PWD': '/builds/slave/test', 16:48:16 INFO - 'SHELL': '/bin/bash', 16:48:16 INFO - 'SHLVL': '1', 16:48:16 INFO - 'TERM': 'linux', 16:48:16 INFO - 'TMOUT': '86400', 16:48:16 INFO - 'USER': 'cltbld', 16:48:16 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 16:48:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:48:16 INFO - '_': '/tools/buildbot/bin/python'} 16:48:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:48:17 INFO - Downloading/unpacking mozsystemmonitor==0.3 16:48:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:48:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:48:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:48:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:48:18 INFO - Downloading mozsystemmonitor-0.3.tar.gz 16:48:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 16:48:18 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 16:48:18 INFO - Installing collected packages: mozsystemmonitor 16:48:18 INFO - Running setup.py install for mozsystemmonitor 16:48:18 INFO - Successfully installed mozsystemmonitor 16:48:18 INFO - Cleaning up... 16:48:18 INFO - Return code: 0 16:48:18 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 16:48:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:48:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:48:18 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1de21f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fada80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2150f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214e130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214f030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x214f4c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:48:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 16:48:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 16:48:18 INFO - Using env: {'DISPLAY': ':0', 16:48:18 INFO - 'HOME': '/home/cltbld', 16:48:18 INFO - 'LANG': 'en_US.UTF-8', 16:48:18 INFO - 'LANGUAGE': 'en_US:en', 16:48:18 INFO - 'LOGNAME': 'cltbld', 16:48:18 INFO - 'MAIL': '/var/mail/cltbld', 16:48:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:48:18 INFO - 'MOZ_NO_REMOTE': '1', 16:48:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:48:18 INFO - 'NO_EM_RESTART': '1', 16:48:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:48:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:48:18 INFO - 'PWD': '/builds/slave/test', 16:48:18 INFO - 'SHELL': '/bin/bash', 16:48:18 INFO - 'SHLVL': '1', 16:48:18 INFO - 'TERM': 'linux', 16:48:18 INFO - 'TMOUT': '86400', 16:48:18 INFO - 'USER': 'cltbld', 16:48:18 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 16:48:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:48:18 INFO - '_': '/tools/buildbot/bin/python'} 16:48:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:48:18 INFO - Downloading/unpacking jsonschema==2.5.1 16:48:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:48:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:48:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:48:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:48:19 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 16:48:19 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 16:48:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:48:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:48:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:48:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:48:19 INFO - Downloading functools32-3.2.3-2.tar.gz 16:48:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 16:48:19 INFO - warning: no files found matching '*.txt' 16:48:19 INFO - no previously-included directories found matching 'build' 16:48:19 INFO - no previously-included directories found matching 'dist' 16:48:19 INFO - no previously-included directories found matching '.git*' 16:48:19 INFO - Installing collected packages: jsonschema, functools32 16:48:19 INFO - Running setup.py install for functools32 16:48:19 INFO - warning: no files found matching '*.txt' 16:48:19 INFO - no previously-included directories found matching 'build' 16:48:19 INFO - no previously-included directories found matching 'dist' 16:48:19 INFO - no previously-included directories found matching '.git*' 16:48:19 INFO - Successfully installed jsonschema functools32 16:48:19 INFO - Cleaning up... 16:48:20 INFO - Return code: 0 16:48:20 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 16:48:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:48:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:48:20 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1de21f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fada80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2150f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214e130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214f030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x214f4c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:48:20 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 16:48:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 16:48:20 INFO - Using env: {'DISPLAY': ':0', 16:48:20 INFO - 'HOME': '/home/cltbld', 16:48:20 INFO - 'LANG': 'en_US.UTF-8', 16:48:20 INFO - 'LANGUAGE': 'en_US:en', 16:48:20 INFO - 'LOGNAME': 'cltbld', 16:48:20 INFO - 'MAIL': '/var/mail/cltbld', 16:48:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:48:20 INFO - 'MOZ_NO_REMOTE': '1', 16:48:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:48:20 INFO - 'NO_EM_RESTART': '1', 16:48:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:48:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:48:20 INFO - 'PWD': '/builds/slave/test', 16:48:20 INFO - 'SHELL': '/bin/bash', 16:48:20 INFO - 'SHLVL': '1', 16:48:20 INFO - 'TERM': 'linux', 16:48:20 INFO - 'TMOUT': '86400', 16:48:20 INFO - 'USER': 'cltbld', 16:48:20 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 16:48:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:48:20 INFO - '_': '/tools/buildbot/bin/python'} 16:48:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:48:20 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 16:48:20 INFO - Cleaning up... 16:48:20 INFO - Return code: 0 16:48:20 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 16:48:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:48:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:48:20 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1de21f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fada80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2150f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214e130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214f030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x214f4c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:48:20 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 16:48:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 16:48:20 INFO - Using env: {'DISPLAY': ':0', 16:48:20 INFO - 'HOME': '/home/cltbld', 16:48:20 INFO - 'LANG': 'en_US.UTF-8', 16:48:20 INFO - 'LANGUAGE': 'en_US:en', 16:48:20 INFO - 'LOGNAME': 'cltbld', 16:48:20 INFO - 'MAIL': '/var/mail/cltbld', 16:48:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:48:20 INFO - 'MOZ_NO_REMOTE': '1', 16:48:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:48:20 INFO - 'NO_EM_RESTART': '1', 16:48:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:48:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:48:20 INFO - 'PWD': '/builds/slave/test', 16:48:20 INFO - 'SHELL': '/bin/bash', 16:48:20 INFO - 'SHLVL': '1', 16:48:20 INFO - 'TERM': 'linux', 16:48:20 INFO - 'TMOUT': '86400', 16:48:20 INFO - 'USER': 'cltbld', 16:48:20 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 16:48:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:48:20 INFO - '_': '/tools/buildbot/bin/python'} 16:48:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:48:20 INFO - Downloading/unpacking blobuploader==1.2.4 16:48:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:48:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:48:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:48:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:48:21 INFO - Downloading blobuploader-1.2.4.tar.gz 16:48:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 16:48:21 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 16:48:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:48:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:48:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:48:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:48:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 16:48:22 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 16:48:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:48:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:48:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:48:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:48:22 INFO - Downloading docopt-0.6.1.tar.gz 16:48:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 16:48:22 INFO - Installing collected packages: blobuploader, requests, docopt 16:48:22 INFO - Running setup.py install for blobuploader 16:48:22 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 16:48:22 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 16:48:22 INFO - Running setup.py install for requests 16:48:22 INFO - Running setup.py install for docopt 16:48:22 INFO - Successfully installed blobuploader requests docopt 16:48:22 INFO - Cleaning up... 16:48:22 INFO - Return code: 0 16:48:22 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:48:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:48:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:48:22 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1de21f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fada80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2150f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214e130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214f030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x214f4c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:48:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 16:48:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 16:48:22 INFO - Using env: {'DISPLAY': ':0', 16:48:22 INFO - 'HOME': '/home/cltbld', 16:48:22 INFO - 'LANG': 'en_US.UTF-8', 16:48:22 INFO - 'LANGUAGE': 'en_US:en', 16:48:22 INFO - 'LOGNAME': 'cltbld', 16:48:22 INFO - 'MAIL': '/var/mail/cltbld', 16:48:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:48:22 INFO - 'MOZ_NO_REMOTE': '1', 16:48:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:48:22 INFO - 'NO_EM_RESTART': '1', 16:48:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:48:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:48:22 INFO - 'PWD': '/builds/slave/test', 16:48:22 INFO - 'SHELL': '/bin/bash', 16:48:22 INFO - 'SHLVL': '1', 16:48:22 INFO - 'TERM': 'linux', 16:48:22 INFO - 'TMOUT': '86400', 16:48:22 INFO - 'USER': 'cltbld', 16:48:22 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 16:48:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:48:22 INFO - '_': '/tools/buildbot/bin/python'} 16:48:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:48:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:48:23 INFO - Running setup.py (path:/tmp/pip-GR1cb9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:48:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:48:23 INFO - Running setup.py (path:/tmp/pip-jBUxWF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:48:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:48:23 INFO - Running setup.py (path:/tmp/pip-O7qIJi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:48:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:48:23 INFO - Running setup.py (path:/tmp/pip-AKuoce-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:48:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:48:23 INFO - Running setup.py (path:/tmp/pip-HCdQWD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:48:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:48:23 INFO - Running setup.py (path:/tmp/pip-LGqaRL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:48:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:48:23 INFO - Running setup.py (path:/tmp/pip-iVnhGr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:48:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:48:23 INFO - Running setup.py (path:/tmp/pip-sBVQSI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:48:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:48:23 INFO - Running setup.py (path:/tmp/pip-oE5igo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:48:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:48:23 INFO - Running setup.py (path:/tmp/pip-etukgD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:48:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:48:23 INFO - Running setup.py (path:/tmp/pip-Ta3iAX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:48:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:48:23 INFO - Running setup.py (path:/tmp/pip-oZnIfz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:48:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:48:23 INFO - Running setup.py (path:/tmp/pip-V3hMHT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:48:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:48:23 INFO - Running setup.py (path:/tmp/pip-gNKmWr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:48:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:48:24 INFO - Running setup.py (path:/tmp/pip-mwTOoB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:48:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:48:24 INFO - Running setup.py (path:/tmp/pip-8wmowO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:48:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:48:24 INFO - Running setup.py (path:/tmp/pip-zSIxUd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:48:24 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 16:48:24 INFO - Running setup.py install for manifestparser 16:48:24 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 16:48:24 INFO - Running setup.py install for mozcrash 16:48:24 INFO - Running setup.py install for mozdebug 16:48:24 INFO - Running setup.py install for mozdevice 16:48:24 INFO - Installing dm script to /builds/slave/test/build/venv/bin 16:48:24 INFO - Running setup.py install for mozfile 16:48:24 INFO - Running setup.py install for mozhttpd 16:48:24 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 16:48:24 INFO - Running setup.py install for mozinfo 16:48:24 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 16:48:24 INFO - Running setup.py install for mozInstall 16:48:25 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 16:48:25 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 16:48:25 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 16:48:25 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 16:48:25 INFO - Running setup.py install for mozleak 16:48:25 INFO - Running setup.py install for mozlog 16:48:25 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 16:48:25 INFO - Running setup.py install for moznetwork 16:48:25 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 16:48:25 INFO - Running setup.py install for mozprocess 16:48:25 INFO - Running setup.py install for mozprofile 16:48:25 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 16:48:25 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 16:48:25 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 16:48:25 INFO - Running setup.py install for mozrunner 16:48:25 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 16:48:25 INFO - Running setup.py install for mozscreenshot 16:48:25 INFO - Running setup.py install for moztest 16:48:25 INFO - Running setup.py install for mozversion 16:48:26 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 16:48:26 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 16:48:26 INFO - Cleaning up... 16:48:26 INFO - Return code: 0 16:48:26 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:48:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:48:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:48:26 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1de21f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fada80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2150f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214e130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214f030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x214f4c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:48:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 16:48:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 16:48:26 INFO - Using env: {'DISPLAY': ':0', 16:48:26 INFO - 'HOME': '/home/cltbld', 16:48:26 INFO - 'LANG': 'en_US.UTF-8', 16:48:26 INFO - 'LANGUAGE': 'en_US:en', 16:48:26 INFO - 'LOGNAME': 'cltbld', 16:48:26 INFO - 'MAIL': '/var/mail/cltbld', 16:48:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:48:26 INFO - 'MOZ_NO_REMOTE': '1', 16:48:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:48:26 INFO - 'NO_EM_RESTART': '1', 16:48:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:48:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:48:26 INFO - 'PWD': '/builds/slave/test', 16:48:26 INFO - 'SHELL': '/bin/bash', 16:48:26 INFO - 'SHLVL': '1', 16:48:26 INFO - 'TERM': 'linux', 16:48:26 INFO - 'TMOUT': '86400', 16:48:26 INFO - 'USER': 'cltbld', 16:48:26 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 16:48:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:48:26 INFO - '_': '/tools/buildbot/bin/python'} 16:48:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:48:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:48:26 INFO - Running setup.py (path:/tmp/pip-XLAuxH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:48:26 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 16:48:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:48:26 INFO - Running setup.py (path:/tmp/pip-hKrN1J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:48:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 16:48:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:48:26 INFO - Running setup.py (path:/tmp/pip-cjECzR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:48:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 16:48:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:48:26 INFO - Running setup.py (path:/tmp/pip-yHpXwy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:48:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.51 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:48:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:48:26 INFO - Running setup.py (path:/tmp/pip-hGT9Vy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:48:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 16:48:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:48:26 INFO - Running setup.py (path:/tmp/pip-rExaPd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:48:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 16:48:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:48:26 INFO - Running setup.py (path:/tmp/pip-8cWDB5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:48:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.10 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 16:48:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:48:26 INFO - Running setup.py (path:/tmp/pip-1vCrHt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:48:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.13 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 16:48:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:48:26 INFO - Running setup.py (path:/tmp/pip-vrREoH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:48:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 16:48:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:48:26 INFO - Running setup.py (path:/tmp/pip-AB1PBp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:48:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.5 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 16:48:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:48:26 INFO - Running setup.py (path:/tmp/pip-7RkeJi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:48:27 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 16:48:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:48:27 INFO - Running setup.py (path:/tmp/pip-zPulIM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:48:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 16:48:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:48:27 INFO - Running setup.py (path:/tmp/pip-McMOqj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:48:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 16:48:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:48:27 INFO - Running setup.py (path:/tmp/pip-3KW8Xe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:48:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 16:48:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:48:27 INFO - Running setup.py (path:/tmp/pip-jaMnyl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:48:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 16:48:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:48:27 INFO - Running setup.py (path:/tmp/pip-rlABBD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:48:27 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 16:48:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:48:27 INFO - Running setup.py (path:/tmp/pip-_310BJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:48:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 16:48:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 16:48:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 16:48:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 16:48:27 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:48:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:48:27 INFO - Requirement already satisfied (use --upgrade to upgrade): requests in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozInstall==1.13->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 16:48:27 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 16:48:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:48:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:48:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:48:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:48:28 INFO - Downloading blessings-1.6.tar.gz 16:48:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 16:48:28 INFO - Installing collected packages: blessings 16:48:28 INFO - Running setup.py install for blessings 16:48:28 INFO - Successfully installed blessings 16:48:28 INFO - Cleaning up... 16:48:28 INFO - Return code: 0 16:48:28 INFO - Done creating virtualenv /builds/slave/test/build/venv. 16:48:28 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:48:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:48:29 INFO - Reading from file tmpfile_stdout 16:48:29 INFO - Current package versions: 16:48:29 INFO - argparse == 1.2.1 16:48:29 INFO - blessings == 1.6 16:48:29 INFO - blobuploader == 1.2.4 16:48:29 INFO - docopt == 0.6.1 16:48:29 INFO - functools32 == 3.2.3-2 16:48:29 INFO - jsonschema == 2.5.1 16:48:29 INFO - manifestparser == 1.1 16:48:29 INFO - mozInstall == 1.13 16:48:29 INFO - mozcrash == 1.0 16:48:29 INFO - mozdebug == 0.1 16:48:29 INFO - mozdevice == 0.51 16:48:29 INFO - mozfile == 1.2 16:48:29 INFO - mozhttpd == 0.7 16:48:29 INFO - mozinfo == 0.10 16:48:29 INFO - mozleak == 0.1 16:48:29 INFO - mozlog == 3.5 16:48:29 INFO - moznetwork == 0.27 16:48:29 INFO - mozprocess == 0.25 16:48:29 INFO - mozprofile == 0.28 16:48:29 INFO - mozrunner == 6.13 16:48:29 INFO - mozscreenshot == 0.1 16:48:29 INFO - mozsystemmonitor == 0.3 16:48:29 INFO - moztest == 0.8 16:48:29 INFO - mozversion == 1.4 16:48:29 INFO - psutil == 3.1.1 16:48:29 INFO - requests == 1.2.3 16:48:29 INFO - wsgiref == 0.1.2 16:48:29 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:48:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:48:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:48:29 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1de21f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fada80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2150f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214e130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214f030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x214f4c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:48:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 16:48:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 16:48:29 INFO - Using env: {'DISPLAY': ':0', 16:48:29 INFO - 'HOME': '/home/cltbld', 16:48:29 INFO - 'LANG': 'en_US.UTF-8', 16:48:29 INFO - 'LANGUAGE': 'en_US:en', 16:48:29 INFO - 'LOGNAME': 'cltbld', 16:48:29 INFO - 'MAIL': '/var/mail/cltbld', 16:48:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:48:29 INFO - 'MOZ_NO_REMOTE': '1', 16:48:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:48:29 INFO - 'NO_EM_RESTART': '1', 16:48:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:48:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:48:29 INFO - 'PWD': '/builds/slave/test', 16:48:29 INFO - 'SHELL': '/bin/bash', 16:48:29 INFO - 'SHLVL': '1', 16:48:29 INFO - 'TERM': 'linux', 16:48:29 INFO - 'TMOUT': '86400', 16:48:29 INFO - 'USER': 'cltbld', 16:48:29 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 16:48:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:48:29 INFO - '_': '/tools/buildbot/bin/python'} 16:48:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:48:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 16:48:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 16:48:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 16:48:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 16:48:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 16:48:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 16:48:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 16:48:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 16:48:29 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 16:48:29 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 16:48:29 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:48:29 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:48:29 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:48:29 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:48:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 16:48:30 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 16:48:30 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 16:48:30 INFO - Installing collected packages: simplejson 16:48:30 INFO - Running setup.py install for simplejson 16:48:30 INFO - building 'simplejson._speedups' extension 16:48:30 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c simplejson/_speedups.c -o build/temp.linux-x86_64-2.7/simplejson/_speedups.o 16:48:31 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/simplejson/_speedups.o -o build/lib.linux-x86_64-2.7/simplejson/_speedups.so 16:48:31 INFO - Successfully installed simplejson 16:48:31 INFO - Cleaning up... 16:48:31 INFO - Return code: 0 16:48:31 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 16:48:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:48:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:48:31 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1de21f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fada80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2150f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214e130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214f030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x214f4c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:48:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 16:48:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 16:48:31 INFO - Using env: {'DISPLAY': ':0', 16:48:31 INFO - 'HOME': '/home/cltbld', 16:48:31 INFO - 'LANG': 'en_US.UTF-8', 16:48:31 INFO - 'LANGUAGE': 'en_US:en', 16:48:31 INFO - 'LOGNAME': 'cltbld', 16:48:31 INFO - 'MAIL': '/var/mail/cltbld', 16:48:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:48:31 INFO - 'MOZ_NO_REMOTE': '1', 16:48:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:48:31 INFO - 'NO_EM_RESTART': '1', 16:48:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:48:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:48:31 INFO - 'PWD': '/builds/slave/test', 16:48:31 INFO - 'SHELL': '/bin/bash', 16:48:31 INFO - 'SHLVL': '1', 16:48:31 INFO - 'TERM': 'linux', 16:48:31 INFO - 'TMOUT': '86400', 16:48:31 INFO - 'USER': 'cltbld', 16:48:31 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 16:48:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:48:31 INFO - '_': '/tools/buildbot/bin/python'} 16:48:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:48:31 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 16:48:31 INFO - Cleaning up... 16:48:31 INFO - Return code: 0 16:48:31 INFO - Running post-action listener: _resource_record_post_action 16:48:31 INFO - Running post-action listener: _start_resource_monitoring 16:48:31 INFO - Starting resource monitoring. 16:48:31 INFO - [mozharness: 2017-08-22 23:48:31.767720Z] Finished create-virtualenv step (success) 16:48:31 INFO - [mozharness: 2017-08-22 23:48:31.768215Z] Running install step. 16:48:31 INFO - Running pre-action listener: _resource_record_pre_action 16:48:31 INFO - Running main action method: install 16:48:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:48:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:48:31 INFO - Reading from file tmpfile_stdout 16:48:31 INFO - Detecting whether we're running mozinstall >=1.0... 16:48:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 16:48:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 16:48:32 INFO - Reading from file tmpfile_stdout 16:48:32 INFO - Output received: 16:48:32 INFO - Usage: mozinstall [options] installer 16:48:32 INFO - Options: 16:48:32 INFO - -h, --help show this help message and exit 16:48:32 INFO - -d DEST, --destination=DEST 16:48:32 INFO - Directory to install application into. [default: 16:48:32 INFO - "/builds/slave/test"] 16:48:32 INFO - --app=APP Application being installed. [default: firefox] 16:48:32 INFO - mkdir: /builds/slave/test/build/application 16:48:32 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 16:48:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 16:48:49 INFO - Reading from file tmpfile_stdout 16:48:49 INFO - Output received: 16:48:49 INFO - /builds/slave/test/build/application/firefox/firefox 16:48:49 INFO - Running post-action listener: _resource_record_post_action 16:48:49 INFO - [mozharness: 2017-08-22 23:48:49.866747Z] Finished install step (success) 16:48:49 INFO - [mozharness: 2017-08-22 23:48:49.867027Z] Running setup-mitmproxy step. 16:48:49 INFO - Running pre-action listener: _resource_record_pre_action 16:48:49 INFO - Running main action method: setup_mitmproxy 16:48:49 INFO - Skipping: mitmproxy is not required 16:48:49 INFO - Running post-action listener: _resource_record_post_action 16:48:49 INFO - [mozharness: 2017-08-22 23:48:49.868166Z] Finished setup-mitmproxy step (success) 16:48:49 INFO - [mozharness: 2017-08-22 23:48:49.868384Z] Running run-tests step. 16:48:49 INFO - Running pre-action listener: _resource_record_pre_action 16:48:49 INFO - Running pre-action listener: _set_gcov_prefix 16:48:49 INFO - Running main action method: run_tests 16:48:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 16:48:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 16:48:49 INFO - Python 2.7.3 16:48:49 INFO - Return code: 0 16:48:49 INFO - grabbing minidump binary from tooltool 16:48:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:48:49 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214e130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x214f030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x214f4c0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 16:48:49 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 16:48:49 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 16:48:49 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 16:48:49 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 16:48:49 INFO - Return code: 0 16:48:49 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 16:48:49 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 16:48:49 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 16:48:49 INFO - ENV: RUST_BACKTRACE is now full 16:48:49 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 16:48:49 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 16:48:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-056', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 16:48:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-056 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 16:48:50 INFO - Using env: {'DISPLAY': ':0', 16:48:50 INFO - 'HOME': '/home/cltbld', 16:48:50 INFO - 'LANG': 'en_US.UTF-8', 16:48:50 INFO - 'LANGUAGE': 'en_US:en', 16:48:50 INFO - 'LOGNAME': 'cltbld', 16:48:50 INFO - 'MAIL': '/var/mail/cltbld', 16:48:50 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 16:48:50 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 16:48:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:48:50 INFO - 'MOZ_NO_REMOTE': '1', 16:48:50 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 16:48:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:48:50 INFO - 'NO_EM_RESTART': '1', 16:48:50 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:48:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:48:50 INFO - 'PWD': '/builds/slave/test', 16:48:50 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 16:48:50 INFO - 'RUST_BACKTRACE': 'full', 16:48:50 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 16:48:50 INFO - 'SHELL': '/bin/bash', 16:48:50 INFO - 'SHLVL': '1', 16:48:50 INFO - 'TERM': 'linux', 16:48:50 INFO - 'TMOUT': '86400', 16:48:50 INFO - 'USER': 'cltbld', 16:48:50 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063', 16:48:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:48:50 INFO - '_': '/tools/buildbot/bin/python'} 16:48:50 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-056', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 16:48:50 INFO - mozversion application_buildid: 20170822224030 16:48:50 INFO - mozversion application_changeset: 80fafbaaf8484104018976c2a0442c91805d3554 16:48:50 INFO - mozversion application_display_name: Nightly 16:48:50 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 16:48:50 INFO - mozversion application_name: Firefox 16:48:50 INFO - mozversion application_remotingname: firefox 16:48:50 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 16:48:50 INFO - mozversion application_vendor: Mozilla 16:48:50 INFO - mozversion application_version: 57.0a1 16:48:50 INFO - mozversion platform_buildid: 20170822224030 16:48:50 INFO - mozversion platform_changeset: 80fafbaaf8484104018976c2a0442c91805d3554 16:48:50 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 16:48:50 INFO - mozversion platform_version: 57.0a1 16:48:50 INFO - using testdate: 1503445730 16:48:50 INFO - actual date: 1503445730 16:48:50 INFO - starting webserver on 'localhost:55681' 16:48:50 INFO - SUITE-START | Running 2 tests 16:48:50 INFO - TEST-START | dromaeo_css 16:48:50 INFO - Initialising browser for dromaeo_css test... 16:48:50 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:55681/getInfo.html -profile /tmp/tmp0JXaYQ/profile 16:48:50 INFO - TEST-INFO | started process 30488 (/builds/slave/test/build/application/firefox/firefox http://localhost:55681/getInfo.html) 16:48:56 INFO - TEST-INFO | 30488: exit 0 16:48:56 INFO - Browser initialized. 16:48:56 INFO - Running cycle 1/1 for dromaeo_css test... 16:48:56 INFO - TEST-INFO | started process 30669 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp0JXaYQ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 16:48:57 INFO - PID 30669 | 16:48:57 INFO - PID 30669 | (/builds/slave/test/build/application/firefox/firefox:30719): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 16:48:57 INFO - PID 30669 | 16:48:57 INFO - PID 30669 | 16:48:57 INFO - PID 30669 | (/builds/slave/test/build/application/firefox/firefox:30776): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 16:48:57 INFO - PID 30669 | 16:48:57 INFO - PID 30669 | __metrics Screen width/height:1600/1200 16:48:57 INFO - PID 30669 | colorDepth:24 16:48:57 INFO - PID 30669 | Browser inner width/height: 1024/768 16:48:57 INFO - PID 30669 | __metrics 16:49:07 INFO - PID 30669 | RSS: Main: 165449728 16:49:07 INFO - PID 30669 | 16:52:06 INFO - PID 30669 | Cycle 1(1): loaded http://localhost:55681/tests/dromaeo/cssquery-dojo.html (next: http://localhost:55681/tests/dromaeo/cssquery-ext.html) 16:52:07 INFO - PID 30669 | RSS: Main: 169394176 16:52:07 INFO - PID 30669 | 16:55:08 INFO - PID 30669 | Cycle 1(1): loaded http://localhost:55681/tests/dromaeo/cssquery-ext.html (next: http://localhost:55681/tests/dromaeo/cssquery-jquery.html) 16:55:09 INFO - PID 30669 | RSS: Main: 166936576 16:55:09 INFO - PID 30669 | 16:58:11 INFO - PID 30669 | Cycle 1(1): loaded http://localhost:55681/tests/dromaeo/cssquery-jquery.html (next: http://localhost:55681/tests/dromaeo/cssquery-mootools.html) 16:58:11 INFO - PID 30669 | RSS: Main: 168693760 16:58:11 INFO - PID 30669 | 17:01:13 INFO - PID 30669 | Cycle 1(1): loaded http://localhost:55681/tests/dromaeo/cssquery-mootools.html (next: http://localhost:55681/tests/dromaeo/cssquery-prototype.html) 17:01:13 INFO - PID 30669 | RSS: Main: 166809600 17:01:13 INFO - PID 30669 | 17:04:16 INFO - PID 30669 | Cycle 1(1): loaded http://localhost:55681/tests/dromaeo/cssquery-prototype.html (next: http://localhost:55681/tests/dromaeo/cssquery-yui.html) 17:04:17 INFO - PID 30669 | RSS: Main: 170520576 17:04:17 INFO - PID 30669 | 17:07:19 INFO - PID 30669 | Cycle 1(1): loaded http://localhost:55681/tests/dromaeo/cssquery-yui.html (next: http://localhost:55681/tests/dromaeo/cssquery-dojo.html) 17:07:19 INFO - PID 30669 | RSS: Main: 170770432 17:07:19 INFO - PID 30669 | 17:07:19 INFO - PID 30669 | __start_tp_report 17:07:19 INFO - PID 30669 | _x_x_mozilla_page_load 17:07:19 INFO - PID 30669 | _x_x_mozilla_page_load_details 17:07:19 INFO - PID 30669 | |i|pagename|runs| 17:07:19 INFO - PID 30669 | |0;dojo.html;3822.8279727412264;3828.7319887607878;3888.1057356807933;3926.4699265599133;3932.7836968966703;5931.940680593193;6118;6124.755009799608;6152.477039451652;6162.106494558287;6017.157597936292;6052.969735151329;6083.78706745264;6105.389461053893;6135.8772824543485;5435.755391007414;5476.726163691809;5478.233047373371;5486.533644640191;5505.532029777473;5576.804811831586;5593.161025846115;5606.971965140168;5629.268195134627;5677.858053548653;5470.17947307903;5548.667079975195;5591.524720398771;5607.4672906074065;5627.099664053752;5375.838724838261;5415.214793854909;5425.077736784756;5538.861528461821;5549.112142057292;5462.562994960394;5485.561155107622;5542.667439953575;5558.082916318803;5561.972190139064;5925.377835327272;5961.821145365646;6016.458518733291;6052.213212282375;6091.908621370683;6464;6526.412622863965;6540.018997150418;6548.312427195171;6558.376954189344;6596.901046484307;6616.20605527335;6620.9006864897065;6627.502937279675;6689.130413046321;6172.783952561684;6177.4440300372735;6200.255969283669;6208.627482351028;6223.502119830403;6560.376764207393;6751.5611485254285;6784.321567843275;6806.76176333826;6818.965905170442;6477.546571739933;6478.384553467413;6507.544471886922;6550.836229094215;6585.868282634417;6513.511486638521;6572.86854262912;6602.405783479414;6676.666166691646;6681.432078273304;6576.473882089422;6581.835454113685;6622.635755033423;6627.403533681992;6630.801075967729;6545.672716364163;6548.639824809681;6626.86746265072;6632.602043877383;6666.533342666064;4831.758412079382;4884.12085824555;4901.607871370282;4956.702597844141;4957.677750946177;4442.600165985077;4500.482444518857;4536.6824322297125;4545.340925565841;4565.703229290086;6085.939140608537;6098.817035488943;6178.6601736904;6182.598131121463;6200.968995155085;6385.297617262097;6473.417392434703;6550.0829883816305;6609.339066093448;6614.470842332602;6070.453659170607;6188.164597779332;6214.937850621526;6227.595206311666;6228.501719862491;5401.7299135043095;5426.104692725735;5456.481634244819;5501.284832971768;5502.174673798882;6812.659367031728;6831.931680683129;6886.449084073262;6924.688389022506;6942.514024018371;6507.934920650733;6533.738650453929;6552.6068435894;6579.901301480386;6602.273749887412;6787.389134977679;6788.389044985975;6884.862302754017;6890.517663763489;6918.619475928671;6470.06184103293;6488.188976377953;6506.056621789909;6605.834854128493;6627.1716035495565;6666.699998500176;6681.131452911285;6714.093597364488;6727.024581435762;6728.629925354153;6294.622322660655;6303.6532990685955;6310.211223597051;6381.1704478417505;6398.232212134388;6247.062940558771;6300.369963003663;6385.96807015962;6395.552311338161;6408.455281301141;6266;6285.402886725754;6305.716242768995;6385.074164246251;6416.486681065597;6441;6442.710078046405;6468.3855033771715;6477.125588045742;6520.608763474017;6143.662098584442;6174.104754810437;6238.750449982132;6247.968760156352;6300.2754683212015 17:07:19 INFO - PID 30669 | |1;ext.html;932.7015355086371;939.2439086535336;960.4141473701042;979.3780949097326;992.3748038735596;34482.48276275855;42953.570464295386;43625.34561981573;43738.56261437385;43868.78065609668;44957.876053098604;45189.548104518944;45265.77367113168;45281.54718452814;45392;7696.4227682923865;7851.136374998746;7852.725154619589;7853.450258481908;7861.017372828396;7977.162397948219;8054.798630034237;8055.63749631268;8058.315043221304;8058.717944871931;8104.837903241932;8135.186481351847;8150.592470376487;8161.836763264731;8165.265126138646;8081.515109093473;8121.675132994673;8122.5126492410345;8122.918770812275;8128.187181281884;7892.763217103496;7941.6029198539845;7979.4015448841565;7989.520628762235;8001.759947201535;40426.39360409567;41060.1787964242;41373.79313103445;41435.792821036004;41436.1712765743;3623.2572322673786;3673.3938900081453;3675.981620091909;3679.300932822755;3682.39240525313;32873.17817054569;32882.50676239858;32931.176720581934;32954.50568241478;33003;5285.550728188108;5348.384935732402;5354.063038968165;5361.571074314045;5400.027994960906;221034;221070;221440;223058;223399;51641.48358516442;51742;51812.22281665778;51893.7405312971;51907.74046129745;54399;54530;54586.18120728192;54595;54626.453735462135;15262;15503.84496155024;16705.91647041757;16796.664066718597;16925.492235232963;13648.112872663245;13727.656808579866;13734.862651373558;13738.65653358674;13761.862381376259;15728.370865165494;15827.129507877178;15851.762223566655;15871.365145394286;15876.364945402285;6380.776672816429;6417.133686952295;6467.385598368148;6478.222613286436;6497.15536980199;1067.8344856547249;1069.3690722473777;1070.0786851894372;1081.8431327457474;1082.2965072702648;24467.65427901447;24745.246008146347;24756.13353532654;24846.37884052913;24857.282824950362;1176.8705442401329;1180.740237147826;1196.8503937007874;1197.3594127141937;1199.8500187476566;16573.91713041427;16833.915830421014;16859;17070.914645426692;17266;302252;304370;304811;307076;307133;64361.67819160874;65231.67384163049;65352;65367;65680.34319656742;1508.7585986242148;1524.7179271834746;1541.2987090873626;1552.1773460066183;1566.3264796137541;28365.149045528666;28454.71545284521;29088.272793179494;29435.558466623446;29485.557716633837;42674.78662606667;42952;43033;43055.13889722125;43055.354169686856;246738;247135;247160;247559;248681;36110.819445902605;37840.43239351357;39501.802490987364;39881.2023759529;39975.80012099921;49753.25370119379;51317.7434112827;51429.742851285504;51654.48345516497;51755;31196.532052018785;31247.598469008506;31486.84256578794;31731.20671983219;31861.20346991251;30468.542971855884;30730.385392292475;31055.378892422475;31285.217869553442;31331.21671958128;41008;41056.38415423831;41273.79363103165;41276;41283;30906.845465772527;31225;31292.217694557818;31424.52863207008;32070.83964580162;25622.61566076473;26302.736972630795;26437;26580.20259392144;26971.190864274104 17:07:19 INFO - PID 30669 | |2;jquery.html;571.3320482502335;572.1589263782239;584.5323741007193;592.6532978207748;596.6569222696949;23501.647475287864;24207.75792242079;24246;24251.636225456634;24267.150649727264;23906.88046559765;26250;26329.210123696274;26496.867515662394;26529.734702652968;6297.779577714769;6451.129097571815;6458.677066146697;6468.223813142429;6481.416672499474;5908.911366329487;6127.662978536178;6352.6188428694195;6388.744450221986;6397.232332120128;6093.238345206849;6107.144999700045;6112.174856394397;6115.174451449042;6116.571839971204;6076.635401875901;6085.513158947318;6085.786997455112;6088.969555152218;6111.327753947062;5643.971780141114;5654.519365853907;5663.235463212455;5676.460736230093;5730.541556675456;30114.548281775573;30622;30971.53542696839;31096.689033109833;31489.8425507871;2212.4579478027827;2267.6031694453404;2268.2288022072407;2268.8184945204507;2270.3189043286948;20354.898225508925;20981.26565570213;20984.790152098438;21013.894930525403;21036.684449733268;2432.5013372258823;2463.642771798079;2524.684414448194;2526.166365099513;2533.290678609974;139660;145653;146341;146464;147040;14915.776263356058;15260.100580889595;15316.463923762614;15822.446214382442;15966.76049859253;24547.140850070162;24972.250832475056;25154.748452515607;25256.747432525808;25309.22835401541;10731.570737170427;10806.675799726021;10824.296420732628;10980.725481863017;11168.106551475863;10123.64567240143;10154.238432117621;10168.542415591317;10184.949075254577;10234.744131396774;9839;9861.556229969668;9911.80176396468;10081.69754907354;10208.234382421348;2646.1025177430683;2669.9466010679675;2750.518659234626;2776.2093449725216;2910.8356657337235;992.7418871093423;993.4883534979491;1028.3521381529588;1029.6087486754984;1031.4636389077637;20584.897075514527;20636.17455301771;20722.274720384714;20804.687929681066;21329.893350533148;1065.7921705267554;1068.941208233539;1074.258761454594;1083.4474418046852;1097.4567589043315;11350.205485615928;11494.080473562095;11573.132015098901;11628.76742465146;11719.828017198382;625946;628694;629285;654573;710978;133656;137629;138724;139260;139280;1286.1125823181974;1286.3761075878192;1324.3643051335414;1325.9867401325864;1336.2316667915793;21181.36455906325;21425.142994280053;21496.24763133283;22100.2264920727;22364.329070127922;62440;66549.33450665431;66912.6654366725;67880;69253.65373173101;80311.59844200741;80782.59608701919;81323.18676813156;81531.59234203791;81768.59115704383;15160.469383571522;15736.606584835014;15737.68524629524;15748.291326890547;15845.445409410615;24747.62878556859;25018.874905625355;25105.372365691004;25133.37166570777;25146.24561263165;18549.35077272289;19462.31881884127;19672;19970.201191952157;19995.200191992157;16349.591260218589;16802.66394672124;16825.326986920387;17124.315027398763;17622.207000684743;19661.606767864847;20293.188272469528;20511.4872128198;20696.17215311371;20705.58588828245;15511.22443877779;15549.378024878879;15622.765658514903;15667.686646267239;15705.822063345066;18171.454856354332;18445.631087378446;18491.167897444917;18575.81424185795;18621.81378186201 17:07:19 INFO - PID 30669 | |3;mootools.html;1442.7330943775403;1484.2578710644677;1486.5094518808794;1514.8030756001722;1521.262187838898;15557.92221038896;16135.757963630555;16224.513264602052;16230.83769162308;16243.675126497477;15763.133027683472;15795.289211985459;15897.12565808883;15929.52211433656;15933.601659958507;2578.961315580263;2601.8959241630314;2639.3401649587604;2676.638653781734;2725.168823508829;2554.463562651845;2624.6325514427995;2646.775024122952;2661.2149415922254;2714.3892624159603;2483.279848843842;2579.9097031603897;2581.8967241310324;2601.947961040778;2646.6691663542056;2531.392465808211;2540.517301712678;2555.527227462925;2563.7436256374494;2601.2456387647558;2613.5426300397353;2767.8892844286206;2768.349437882096;2769.6399468069226;2772.7088655691064;15884.04695718249;16075;16118.355265789472;16125.758113628304;16133.274002669908;7995.720149794787;8291.709790157376;8303.792405189859;8312.501249925024;8316.501009939422;5117.309163262949;5370.946290537084;5447.455254474521;5503.587230957694;5504;1901.1539864760186;1943.4055535859645;1943.6987266973642;1966.6263409952064;1975.1605567633699;27771.778257739334;28156.859215703997;28386.432271354457;28447.288817779514;28514.287142821388;7003.669302832445;7101.751438699621;7145.749898753519;7173.461990350745;7452.06849143857;18296.63406731858;18300.90849545744;18491.907540462482;18520.073996300132;18581.25674973013;8325.167483251747;8373.204545568162;8378.12029736881;8381.916180838114;8483.406161568755;7567.545947243183;7737.0715514138665;7776.883346749803;7818.569978651115;7832.569208693577;5703.600747947687;5824.446677565625;5884.205632239678;5922.466977971917;6085.330613632497;1763.7795275590552;1817.5546990987293;1825.7443957845912;1849.537615596101;1855.1373611270824;938.8591711243231;993.5975929748463;995.9402435853872;996.6960077176531;1006.1548299428515;8301.46040507365;8316.5425901576;8458.619362128718;8459.111793261742;8512.957435212784;745.7725393754957;747.7158679701679;749.7759633575603;760.1068744225513;765.8276887700223;5539.623697279105;5672.5745569081655;5774.595778295479;5841.9415805842245;5979.983402821531;22293.108275669118;22686.886565567067;23039.193628222933;23319.53360932772;23444.531109377716;23211.303660889862;23370.64944025841;23478;23587.056517739442;23592.528149437258;11054.613088542023;11658.708532286591;11666.766664666658;11872.22830516031;11970.700732481584;9345.48599827016;9455.952720236355;9541.332106752738;9880.35777674449;9916.256280779115;19741.802581973996;20033.799662003777;20085.698714519585;20410.693839592714;21124.577508450053;20313.49216269546;20649.27727529529;20751.584968300853;20893.26873559479;21044.68432973476;12781.297028663514;13121.606351809462;13127.474901003852;13131.34343282813;13144;14635.707285854436;14682;14688.632784180054;14819.40722371093;14829.925850370679;10957.232993690364;11233.213675042996;11309.660710178709;11462.94268528652;11480.598179063692;11020.173486988668;11059.668209953714;11129.83305250438;11243.718907027063;11425.14311426663;9282.489463079595;9364.110409511086;10507.211959102944;10661.840072398765;10774.946125269636;7965.359347003737;7973.920260797549;8008.399370047153;8033.156518565466;8149.551774652451;7923.920760792549;7968.521888686466;7990.6004699765945;7997.800054998672;8053.597320134087 17:07:19 INFO - PID 30669 | |4;prototype.html;534.9197620356946;542.1596525385656;563.8533981164899;565.2736233939387;571.9313682358115;5994.9999999999945;6046.576739628223;6068.757249710012;6101.603395779282;6115.266168059828;5992.741524279895;5996.880062398749;6032.87934241316;6038.033914573669;6062;4950.480199579047;4961.189165954419;4998.625103117262;5012.774425150877;5012.799488020493;4736.9526304736855;4924.162892308298;4971.37857767779;4974.42794078682;5022.17134172861;4763.90472190556;4792.712437253758;4799.520047995207;4829;4836;4781.306710526971;4792.472827988919;4824.396950381202;4862.756862156878;4881.60874150867;4268.701190916637;4352.73883566987;4378.365137055109;4396.274614688573;4397.9560204398185;5868.794592189253;5869.354371019184;5895.852603684899;5899.056151015817;5900.1739756434135;5527.060399732015;5574.777008919679;5593.105103183471;5639.492445679908;5651.8304450866535;6402.583832050948;6410.615363078184;6419.293877673452;6440;6457.709403076873;4837.7339246341435;4853.466118726938;4859.271109333593;4861.683990540603;4891.1195984722735;6395.296517383084;6456.3220861809305;6471.320511346288;6629.469642428594;6667.19993600771;4968.633625752875;4971.055499455092;4971.1797553403285;5000.224965130411;5013.498650134958;5008.91951449863;5015.27278544609;5037.798488060436;5056.570191533688;5081.390233172043;5556.305461817273;5579.553635709133;5585.357683866408;5601.5238704709745;5605.5515558755205;6385;6408.423241908251;6431.163948686641;6443.903341449882;6466.288708242089;1737.4440179142805;1744.3981826269917;1746.3974928649595;1756.8945863248246;1760.9698326478897;1190.833283340333;1222.7554489102215;1245.937972655257;1246.5013994402311;1251.443107817031;6016.819495415145;6060.636361818305;6066.66633335162;6081.331053584102;6134.35589263121;6406.711697973602;6475.611463312216;6491.902621460682;6544.509161812883;6555.180602424697;5911.788083442884;5959.344472108065;5969.791057312973;5980.671063091485;6041;3372.780769249991;3412.948805767866;3426.5716785401823;3436.106612280775;3443.8794642187404;6841.760538381132;6857.794266172023;6866.622335771581;6884.070650462124;6897.3447522485285;6654.037059067587;6718.514149764618;6719.092922455406;6725.8654826903185;6731.966340168267;6776.254611992578;6842.452603791585;6867.175938887365;6930.203026651899;6939.968522820915;5970.238779559953;6463.935360646334;6478.676066196577;6482.643454610042;6555.4427873629365;6388.55280130405;6444;6446.387593178641;6473.967630161819;6480.384363485461;6771.52599318043;6877.759278425231;6919.37725604698;6933.2026816916705;6947.93052069493;4895.545054000842;4929.556339929423;4948.406191256928;4953.479884612064;4988.725620090785;6372.681365931592;6377.521685873671;6523.869522609616;6556.8360790980605;6623.536352455282;6123.326434092157;6339.778107766206;6343.207099112611;6371.362863713592;6386.648734319657;6358.554901156875;6373.203349581302;6384.808455746335;6408.743650254124;6420.678966051585;6348.523860710373;6374.139491168633;6390.329015453311;6414.390632889868;6421.325760795049;6442.452391546583;6442.581232219891;6455.580387274812;6478.578892371981;6481.902771458526;6269.780557680641;6274.341194174546;6284.120223168668;6293.937060629335;6295.307516173309 17:07:19 INFO - PID 30669 | |5;yui.html;952.3000594562996;978.1196922769507;1000.4897502273839;1006.3408467453811;1009.1170226052204;17236.48290551284;17941.820581794178;17975.10124493775;18016.18927148278;20805;21085.156593736232;21452.785472145275;21480.57038859222;21481.46296342592;21703.565928681415;992.0823238504373;1010.7927874785652;1015.1675625986694;1019.7399663085903;1029.3566520924421;971.2666936462961;1056.1234175634206;1066.7119877633033;1078.8435676826855;1079.7624522605015;1137.2550979108655;1144.7939370913232;1145.34715212329;1146.5070019891443;1147.1969621265107;1134.024738724692;1134.9092072634169;1136.494260054276;1136.8806275341094;1139.1627154041773;838.4759525296689;838.4801423117706;838.5974732128612;838.9077201507829;839.1943734015352;19303.806961930342;20256.79743202564;20337.898310508353;20507;20508.897455512775;21263.68104478434;21395.786042139534;21511.892440537853;21671.133154673793;21808.345749627537;17425.47723568295;17509.212085456184;17750.822491775045;17823.376181833573;18008.549786255448;3897.3179693553516;3906.3359228930867;3911.432842237888;3917.4515567820526;3917.490726205575;134650;136527;138681;138935;142099.57900420966;16666.166691665367;16920.40778572744;17037.829621703626;17087.145642717813;17096.82903170977;31791.364172716418;33185.336293274;33383;33430.66569334324;33438.331233375684;8155.959220203979;9186.86219706705;9802.705918822447;9805.264605154642;9924.057214564606;4693.507181745936;4797.016611594615;4817.494163112893;4820.108279968217;4836.927446088312;5514.5864060195645;5536.612437129443;5595.804146854841;5626.971865140648;5669.716514174274;1155.7977353963022;1176.588194132047;1190.458341454636;1190.458341454636;1194.6117511808523;739.2348918868945;744.0959234530072;755.4258763339791;766.2490759056157;781.5896654256447;12615.549211840573;13004.349782511026;13107.672308192181;13313.733725325439;13582.388792504362;743.18992298395;748.831512909591;749.8387846612895;767.8464307138482;771.9614019299013;6023.6385816851125;6079.544034197453;6143.600665956698;6178.783742568989;6179.258488981351;128443;129729;130101.34949325382;131335;134350.32824836008;117002.41498792451;118496.40751796185;119401.40299298622;119998;123775;101358.4932075335;102562;102696.48651756694;104371;104425;11434.542618295174;11579.478923448296;11689.240199387013;11993.76012479728;12005.75988480208;49014.75492622514;49192;49966.75016624894;50246.7487662574;51843.22235166551;63880.68059659672;64231.67884160549;64417.67791161014;65544.67227663832;65696.01455978259;15672.451464198699;15775.132367719885;16082.919585401998;16149.111798851176;16374.590635234214;22477.550448991256;22503.549929001;22561.43596410103;22628.981695824055;22808.771912280667;20017.199312027355;20376;20377;20526;20551.177952881717;20149.798502014793;20200.89899550493;20454.488637784176;20459.181632734522;20479.078441469872;20674.173033078507;20882;21102.47243818917;21258.78741212568;21720.456988575414;13331.200127992352;14238.359273832495;14328.785068224193;14525.418983240552;14570.271486425849;15166.24168791578;15442.922785386001;15933.60165995813;16020.839791601935;16728.916355418143 17:07:19 INFO - PID 30669 | __end_tp_report 17:07:19 INFO - PID 30669 | __start_cc_report 17:07:19 INFO - PID 30669 | _x_x_mozilla_cycle_collect,372 17:07:19 INFO - PID 30669 | __end_cc_report 17:07:19 INFO - PID 30669 | __startTimestamp1503446839376__endTimestamp 17:07:19 INFO - PID 30669 | 17:07:19 INFO - PID 30669 | ------- Summary: start ------- 17:07:19 INFO - PID 30669 | Number of tests: 6 17:07:19 INFO - PID 30669 | 17:07:19 INFO - PID 30669 | [#0] dojo.html Cycles:165 Average:6095.00 Median:6294.62 stddev:683.10 (10.9%) stddev-sans-first:661.53 17:07:19 INFO - PID 30669 | Values: 3822.8 3828.7 3888.1 3926.5 3932.8 5931.9 6118.0 6124.8 6152.5 6162.1 6017.2 6053.0 6083.8 6105.4 6135.9 5435.8 5476.7 5478.2 5486.5 5505.5 5576.8 5593.2 5607.0 5629.3 5677.9 5470.2 5548.7 5591.5 5607.5 5627.1 5375.8 5415.2 5425.1 5538.9 5549.1 5462.6 5485.6 5542.7 5558.1 5562.0 5925.4 5961.8 6016.5 6052.2 6091.9 6464.0 6526.4 6540.0 6548.3 6558.4 6596.9 6616.2 6620.9 6627.5 6689.1 6172.8 6177.4 6200.3 6208.6 6223.5 6560.4 6751.6 6784.3 6806.8 6819.0 6477.5 6478.4 6507.5 6550.8 6585.9 6513.5 6572.9 6602.4 6676.7 6681.4 6576.5 6581.8 6622.6 6627.4 6630.8 6545.7 6548.6 6626.9 6632.6 6666.5 4831.8 4884.1 4901.6 4956.7 4957.7 4442.6 4500.5 4536.7 4545.3 4565.7 6085.9 6098.8 6178.7 6182.6 6201.0 6385.3 6473.4 6550.1 6609.3 6614.5 6070.5 6188.2 6214.9 6227.6 6228.5 5401.7 5426.1 5456.5 5501.3 5502.2 6812.7 6831.9 6886.4 6924.7 6942.5 6507.9 6533.7 6552.6 6579.9 6602.3 6787.4 6788.4 6884.9 6890.5 6918.6 6470.1 6488.2 6506.1 6605.8 6627.2 6666.7 6681.1 6714.1 6727.0 6728.6 6294.6 6303.7 6310.2 6381.2 6398.2 6247.1 6300.4 6386.0 6395.6 6408.5 6266.0 6285.4 6305.7 6385.1 6416.5 6441.0 6442.7 6468.4 6477.1 6520.6 6143.7 6174.1 6238.8 6248.0 6300.3 17:07:19 INFO - PID 30669 | 17:07:19 INFO - PID 30669 | [#1] ext.html Cycles:180 Average:43836.22 Median:3680.85 stddev:67905.11 (1844.8%) stddev-sans-first:68019.19 17:07:19 INFO - PID 30669 | Values: 932.7 939.2 960.4 979.4 992.4 34482.5 42953.6 43625.3 43738.6 43868.8 44957.9 45189.5 45265.8 45281.5 45392.0 7696.4 7851.1 7852.7 7853.5 7861.0 7977.2 8054.8 8055.6 8058.3 8058.7 8104.8 8135.2 8150.6 8161.8 8165.3 8081.5 8121.7 8122.5 8122.9 8128.2 7892.8 7941.6 7979.4 7989.5 8001.8 40426.4 41060.2 41373.8 41435.8 41436.2 3623.3 3673.4 3676.0 3679.3 3682.4 32873.2 32882.5 32931.2 32954.5 33003.0 5285.6 5348.4 5354.1 5361.6 5400.0 221034.0 221070.0 221440.0 223058.0 223399.0 51641.5 51742.0 51812.2 51893.7 51907.7 54399.0 54530.0 54586.2 54595.0 54626.5 15262.0 15503.8 16705.9 16796.7 16925.5 13648.1 13727.7 13734.9 13738.7 13761.9 15728.4 15827.1 15851.8 15871.4 15876.4 6380.8 6417.1 6467.4 6478.2 6497.2 1067.8 1069.4 1070.1 1081.8 1082.3 24467.7 24745.2 24756.1 24846.4 24857.3 1176.9 1180.7 1196.9 1197.4 1199.9 16573.9 16833.9 16859.0 17070.9 17266.0 302252.0 304370.0 304811.0 307076.0 307133.0 64361.7 65231.7 65352.0 65367.0 65680.3 1508.8 1524.7 1541.3 1552.2 1566.3 28365.1 28454.7 29088.3 29435.6 29485.6 42674.8 42952.0 43033.0 43055.1 43055.4 246738.0 247135.0 247160.0 247559.0 248681.0 36110.8 37840.4 39501.8 39881.2 39975.8 49753.3 51317.7 51429.7 51654.5 51755.0 31196.5 31247.6 31486.8 31731.2 31861.2 30468.5 30730.4 31055.4 31285.2 31331.2 41008.0 41056.4 41273.8 41276.0 41283.0 30906.8 31225.0 31292.2 31424.5 32070.8 25622.6 26302.7 26437.0 26580.2 26971.2 17:07:19 INFO - PID 30669 | 17:07:19 INFO - PID 30669 | [#2] jquery.html Cycles:180 Average:41149.68 Median:12315.97 stddev:108455.35 (880.6%) stddev-sans-first:108716.80 17:07:19 INFO - PID 30669 | Values: 571.3 572.2 584.5 592.7 596.7 23501.6 24207.8 24246.0 24251.6 24267.2 23906.9 26250.0 26329.2 26496.9 26529.7 6297.8 6451.1 6458.7 6468.2 6481.4 5908.9 6127.7 6352.6 6388.7 6397.2 6093.2 6107.1 6112.2 6115.2 6116.6 6076.6 6085.5 6085.8 6089.0 6111.3 5644.0 5654.5 5663.2 5676.5 5730.5 30114.5 30622.0 30971.5 31096.7 31489.8 2212.5 2267.6 2268.2 2268.8 2270.3 20354.9 20981.3 20984.8 21013.9 21036.7 2432.5 2463.6 2524.7 2526.2 2533.3 139660.0 145653.0 146341.0 146464.0 147040.0 14915.8 15260.1 15316.5 15822.4 15966.8 24547.1 24972.3 25154.7 25256.7 25309.2 10731.6 10806.7 10824.3 10980.7 11168.1 10123.6 10154.2 10168.5 10184.9 10234.7 9839.0 9861.6 9911.8 10081.7 10208.2 2646.1 2669.9 2750.5 2776.2 2910.8 992.7 993.5 1028.4 1029.6 1031.5 20584.9 20636.2 20722.3 20804.7 21329.9 1065.8 1068.9 1074.3 1083.4 1097.5 11350.2 11494.1 11573.1 11628.8 11719.8 625946.0 628694.0 629285.0 654573.0 710978.0 133656.0 137629.0 138724.0 139260.0 139280.0 1286.1 1286.4 1324.4 1326.0 1336.2 21181.4 21425.1 21496.2 22100.2 22364.3 62440.0 66549.3 66912.7 67880.0 69253.7 80311.6 80782.6 81323.2 81531.6 81768.6 15160.5 15736.6 15737.7 15748.3 15845.4 24747.6 25018.9 25105.4 25133.4 25146.2 18549.4 19462.3 19672.0 19970.2 19995.2 16349.6 16802.7 16825.3 17124.3 17622.2 19661.6 20293.2 20511.5 20696.2 20705.6 15511.2 15549.4 15622.8 15667.7 15705.8 18171.5 18445.6 18491.2 18575.8 18621.8 17:07:19 INFO - PID 30669 | 17:07:19 INFO - PID 30669 | [#3] mootools.html Cycles:180 Average:9914.86 Median:2579.44 stddev:7186.11 (278.6%) stddev-sans-first:7178.08 17:07:19 INFO - PID 30669 | Values: 1442.7 1484.3 1486.5 1514.8 1521.3 15557.9 16135.8 16224.5 16230.8 16243.7 15763.1 15795.3 15897.1 15929.5 15933.6 2579.0 2601.9 2639.3 2676.6 2725.2 2554.5 2624.6 2646.8 2661.2 2714.4 2483.3 2579.9 2581.9 2601.9 2646.7 2531.4 2540.5 2555.5 2563.7 2601.2 2613.5 2767.9 2768.3 2769.6 2772.7 15884.0 16075.0 16118.4 16125.8 16133.3 7995.7 8291.7 8303.8 8312.5 8316.5 5117.3 5370.9 5447.5 5503.6 5504.0 1901.2 1943.4 1943.7 1966.6 1975.2 27771.8 28156.9 28386.4 28447.3 28514.3 7003.7 7101.8 7145.7 7173.5 7452.1 18296.6 18300.9 18491.9 18520.1 18581.3 8325.2 8373.2 8378.1 8381.9 8483.4 7567.5 7737.1 7776.9 7818.6 7832.6 5703.6 5824.4 5884.2 5922.5 6085.3 1763.8 1817.6 1825.7 1849.5 1855.1 938.9 993.6 995.9 996.7 1006.2 8301.5 8316.5 8458.6 8459.1 8513.0 745.8 747.7 749.8 760.1 765.8 5539.6 5672.6 5774.6 5841.9 5980.0 22293.1 22686.9 23039.2 23319.5 23444.5 23211.3 23370.6 23478.0 23587.1 23592.5 11054.6 11658.7 11666.8 11872.2 11970.7 9345.5 9456.0 9541.3 9880.4 9916.3 19741.8 20033.8 20085.7 20410.7 21124.6 20313.5 20649.3 20751.6 20893.3 21044.7 12781.3 13121.6 13127.5 13131.3 13144.0 14635.7 14682.0 14688.6 14819.4 14829.9 10957.2 11233.2 11309.7 11462.9 11480.6 11020.2 11059.7 11129.8 11243.7 11425.1 9282.5 9364.1 10507.2 10661.8 10774.9 7965.4 7973.9 8008.4 8033.2 8149.6 7923.9 7968.5 7990.6 7997.8 8053.6 17:07:19 INFO - PID 30669 | 17:07:19 INFO - PID 30669 | [#4] prototype.html Cycles:180 Average:5451.88 Median:6039.52 stddev:1529.92 (25.3%) stddev-sans-first:1489.04 17:07:19 INFO - PID 30669 | Values: 534.9 542.2 563.9 565.3 571.9 5995.0 6046.6 6068.8 6101.6 6115.3 5992.7 5996.9 6032.9 6038.0 6062.0 4950.5 4961.2 4998.6 5012.8 5012.8 4737.0 4924.2 4971.4 4974.4 5022.2 4763.9 4792.7 4799.5 4829.0 4836.0 4781.3 4792.5 4824.4 4862.8 4881.6 4268.7 4352.7 4378.4 4396.3 4398.0 5868.8 5869.4 5895.9 5899.1 5900.2 5527.1 5574.8 5593.1 5639.5 5651.8 6402.6 6410.6 6419.3 6440.0 6457.7 4837.7 4853.5 4859.3 4861.7 4891.1 6395.3 6456.3 6471.3 6629.5 6667.2 4968.6 4971.1 4971.2 5000.2 5013.5 5008.9 5015.3 5037.8 5056.6 5081.4 5556.3 5579.6 5585.4 5601.5 5605.6 6385.0 6408.4 6431.2 6443.9 6466.3 1737.4 1744.4 1746.4 1756.9 1761.0 1190.8 1222.8 1245.9 1246.5 1251.4 6016.8 6060.6 6066.7 6081.3 6134.4 6406.7 6475.6 6491.9 6544.5 6555.2 5911.8 5959.3 5969.8 5980.7 6041.0 3372.8 3412.9 3426.6 3436.1 3443.9 6841.8 6857.8 6866.6 6884.1 6897.3 6654.0 6718.5 6719.1 6725.9 6732.0 6776.3 6842.5 6867.2 6930.2 6940.0 5970.2 6463.9 6478.7 6482.6 6555.4 6388.6 6444.0 6446.4 6474.0 6480.4 6771.5 6877.8 6919.4 6933.2 6947.9 4895.5 4929.6 4948.4 4953.5 4988.7 6372.7 6377.5 6523.9 6556.8 6623.5 6123.3 6339.8 6343.2 6371.4 6386.6 6358.6 6373.2 6384.8 6408.7 6420.7 6348.5 6374.1 6390.3 6414.4 6421.3 6442.5 6442.6 6455.6 6478.6 6481.9 6269.8 6274.3 6284.1 6293.9 6295.3 17:07:19 INFO - PID 30669 | 17:07:19 INFO - PID 30669 | [#5] yui.html Cycles:180 Average:26385.68 Median:20356.95 stddev:37068.02 (182.1%) stddev-sans-first:37122.81 17:07:19 INFO - PID 30669 | Values: 952.3 978.1 1000.5 1006.3 1009.1 17236.5 17941.8 17975.1 18016.2 20805.0 21085.2 21452.8 21480.6 21481.5 21703.6 992.1 1010.8 1015.2 1019.7 1029.4 971.3 1056.1 1066.7 1078.8 1079.8 1137.3 1144.8 1145.3 1146.5 1147.2 1134.0 1134.9 1136.5 1136.9 1139.2 838.5 838.5 838.6 838.9 839.2 19303.8 20256.8 20337.9 20507.0 20508.9 21263.7 21395.8 21511.9 21671.1 21808.3 17425.5 17509.2 17750.8 17823.4 18008.5 3897.3 3906.3 3911.4 3917.5 3917.5 134650.0 136527.0 138681.0 138935.0 142099.6 16666.2 16920.4 17037.8 17087.1 17096.8 31791.4 33185.3 33383.0 33430.7 33438.3 8156.0 9186.9 9802.7 9805.3 9924.1 4693.5 4797.0 4817.5 4820.1 4836.9 5514.6 5536.6 5595.8 5627.0 5669.7 1155.8 1176.6 1190.5 1190.5 1194.6 739.2 744.1 755.4 766.2 781.6 12615.5 13004.3 13107.7 13313.7 13582.4 743.2 748.8 749.8 767.8 772.0 6023.6 6079.5 6143.6 6178.8 6179.3 128443.0 129729.0 130101.3 131335.0 134350.3 117002.4 118496.4 119401.4 119998.0 123775.0 101358.5 102562.0 102696.5 104371.0 104425.0 11434.5 11579.5 11689.2 11993.8 12005.8 49014.8 49192.0 49966.8 50246.7 51843.2 63880.7 64231.7 64417.7 65544.7 65696.0 15672.5 15775.1 16082.9 16149.1 16374.6 22477.6 22503.5 22561.4 22629.0 22808.8 20017.2 20376.0 20377.0 20526.0 20551.2 20149.8 20200.9 20454.5 20459.2 20479.1 20674.2 20882.0 21102.5 21258.8 21720.5 13331.2 14238.4 14328.8 14525.4 14570.3 15166.2 15442.9 15933.6 16020.8 16728.9 17:07:19 INFO - PID 30669 | -------- Summary: end -------- 17:07:19 INFO - PID 30669 | 17:07:20 INFO - TEST-INFO | 30669: exit 0 17:07:20 INFO - TEST-OK | dromaeo_css | took 1109876ms 17:07:20 INFO - TEST-START | kraken 17:07:20 INFO - Initialising browser for kraken test... 17:07:20 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:55681/getInfo.html -profile /tmp/tmpweAhim/profile 17:07:20 INFO - TEST-INFO | started process 31087 (/builds/slave/test/build/application/firefox/firefox http://localhost:55681/getInfo.html) 17:07:25 INFO - TEST-INFO | 31087: exit 0 17:07:25 INFO - Browser initialized. 17:07:25 INFO - Running cycle 1/1 for kraken test... 17:07:25 INFO - TEST-INFO | started process 31266 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpweAhim/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 17:07:26 INFO - PID 31266 | 17:07:26 INFO - PID 31266 | (/builds/slave/test/build/application/firefox/firefox:31316): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 17:07:26 INFO - PID 31266 | 17:07:27 INFO - PID 31266 | 17:07:27 INFO - PID 31266 | (/builds/slave/test/build/application/firefox/firefox:31373): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 17:07:27 INFO - PID 31266 | 17:07:27 INFO - PID 31266 | __metrics Screen width/height:1600/1200 17:07:27 INFO - PID 31266 | colorDepth:24 17:07:27 INFO - PID 31266 | Browser inner width/height: 1024/768 17:07:27 INFO - PID 31266 | __metrics 17:07:37 INFO - PID 31266 | RSS: Main: 165638144 17:07:37 INFO - PID 31266 | 17:07:39 INFO - PID 31266 | Cycle 1(1): loaded http://localhost:55681/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:55681/tests/kraken/driver.html?testName=audio-beat-detection) 17:07:40 INFO - PID 31266 | RSS: Main: 169422848 17:07:40 INFO - PID 31266 | 17:07:43 INFO - PID 31266 | Cycle 1(1): loaded http://localhost:55681/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:55681/tests/kraken/driver.html?testName=audio-dft) 17:07:43 INFO - PID 31266 | RSS: Main: 171827200 17:07:43 INFO - PID 31266 | 17:07:46 INFO - PID 31266 | Cycle 1(1): loaded http://localhost:55681/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:55681/tests/kraken/driver.html?testName=audio-fft) 17:07:47 INFO - PID 31266 | RSS: Main: 165400576 17:07:47 INFO - PID 31266 | 17:07:49 INFO - PID 31266 | Cycle 1(1): loaded http://localhost:55681/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:55681/tests/kraken/driver.html?testName=audio-oscillator) 17:07:49 INFO - PID 31266 | RSS: Main: 166555648 17:07:49 INFO - PID 31266 | 17:07:52 INFO - PID 31266 | Cycle 1(1): loaded http://localhost:55681/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:55681/tests/kraken/driver.html?testName=imaging-gaussian-blur) 17:07:52 INFO - PID 31266 | RSS: Main: 166567936 17:07:52 INFO - PID 31266 | 17:07:55 INFO - PID 31266 | Cycle 1(1): loaded http://localhost:55681/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:55681/tests/kraken/driver.html?testName=imaging-darkroom) 17:07:56 INFO - PID 31266 | RSS: Main: 168349696 17:07:56 INFO - PID 31266 | 17:07:59 INFO - PID 31266 | Cycle 1(1): loaded http://localhost:55681/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:55681/tests/kraken/driver.html?testName=imaging-desaturate) 17:08:00 INFO - PID 31266 | RSS: Main: 169676800 17:08:00 INFO - PID 31266 | 17:08:03 INFO - PID 31266 | Cycle 1(1): loaded http://localhost:55681/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:55681/tests/kraken/driver.html?testName=json-parse-financial) 17:08:03 INFO - PID 31266 | RSS: Main: 168644608 17:08:03 INFO - PID 31266 | 17:08:05 INFO - PID 31266 | Cycle 1(1): loaded http://localhost:55681/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:55681/tests/kraken/driver.html?testName=json-stringify-tinderbox) 17:08:05 INFO - PID 31266 | RSS: Main: 168259584 17:08:05 INFO - PID 31266 | 17:08:07 INFO - PID 31266 | Cycle 1(1): loaded http://localhost:55681/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:55681/tests/kraken/driver.html?testName=stanford-crypto-aes) 17:08:08 INFO - PID 31266 | RSS: Main: 168431616 17:08:08 INFO - PID 31266 | 17:08:10 INFO - PID 31266 | Cycle 1(1): loaded http://localhost:55681/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:55681/tests/kraken/driver.html?testName=stanford-crypto-ccm) 17:08:10 INFO - PID 31266 | RSS: Main: 168595456 17:08:10 INFO - PID 31266 | 17:08:13 INFO - PID 31266 | Cycle 1(1): loaded http://localhost:55681/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:55681/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 17:08:14 INFO - PID 31266 | RSS: Main: 168267776 17:08:14 INFO - PID 31266 | 17:08:17 INFO - PID 31266 | Cycle 1(1): loaded http://localhost:55681/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:55681/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 17:08:17 INFO - PID 31266 | RSS: Main: 168849408 17:08:17 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | Cycle 1(1): loaded http://localhost:55681/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:55681/tests/kraken/driver.html?testName=ai-astar) 17:08:19 INFO - PID 31266 | RSS: Main: 170414080 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | __start_tp_report 17:08:19 INFO - PID 31266 | _x_x_mozilla_page_load 17:08:19 INFO - PID 31266 | _x_x_mozilla_page_load_details 17:08:19 INFO - PID 31266 | |i|pagename|runs| 17:08:19 INFO - PID 31266 | |0;ai-astar;96;107;99;105;107;108;111;99;107;109 17:08:19 INFO - PID 31266 | |1;audio-beat-detection;146;115;141;166;116;146;141;120;165;124 17:08:19 INFO - PID 31266 | |2;audio-dft;168;165;164;163;161;164;160;161;166;176 17:08:19 INFO - PID 31266 | |3;audio-fft;74;74;77;174;76;74;74;74;158;75 17:08:19 INFO - PID 31266 | |4;audio-oscillator;81;79;127;78;79;80;136;79;79;131 17:08:19 INFO - PID 31266 | |5;imaging-gaussian-blur;116;115;114;114;114;114;115;113;114;114 17:08:19 INFO - PID 31266 | |6;imaging-darkroom;150;152;150;151;151;150;151;152;151;152 17:08:19 INFO - PID 31266 | |7;imaging-desaturate;96;95;95;95;96;95;95;95;94;94 17:08:19 INFO - PID 31266 | |8;json-parse-financial;45;44;45;48;45;46;45;55;46;45 17:08:19 INFO - PID 31266 | |9;json-stringify-tinderbox;52;51;52;52;52;51;51;51;51;51 17:08:19 INFO - PID 31266 | |10;stanford-crypto-aes;75;84;74;76;75;75;72;74;74;73 17:08:19 INFO - PID 31266 | |11;stanford-crypto-ccm;123;118;122;118;115;120;123;114;116;160 17:08:19 INFO - PID 31266 | |12;stanford-crypto-pbkdf2;174;188;166;173;181;167;169;167;174;162 17:08:19 INFO - PID 31266 | |13;stanford-crypto-sha256-iterative;61;64;61;63;63;63;63;61;63;63 17:08:19 INFO - PID 31266 | __end_tp_report 17:08:19 INFO - PID 31266 | __start_cc_report 17:08:19 INFO - PID 31266 | _x_x_mozilla_cycle_collect,902 17:08:19 INFO - PID 31266 | __end_cc_report 17:08:19 INFO - PID 31266 | __startTimestamp1503446899578__endTimestamp 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | ------- Summary: start ------- 17:08:19 INFO - PID 31266 | Number of tests: 14 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | [#0] ai-astar Cycles:10 Average:104.80 Median:110.00 stddev:5.01 (4.6%) stddev-sans-first:4.18 17:08:19 INFO - PID 31266 | Values: 96.0 107.0 99.0 105.0 107.0 108.0 111.0 99.0 107.0 109.0 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | [#1] audio-beat-detection Cycles:10 Average:138.00 Median:143.50 stddev:18.83 (13.1%) stddev-sans-first:19.75 17:08:19 INFO - PID 31266 | Values: 146.0 115.0 141.0 166.0 116.0 146.0 141.0 120.0 165.0 124.0 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | [#2] audio-dft Cycles:10 Average:164.80 Median:164.50 stddev:4.64 (2.8%) stddev-sans-first:4.77 17:08:19 INFO - PID 31266 | Values: 168.0 165.0 164.0 163.0 161.0 164.0 160.0 161.0 166.0 176.0 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | [#3] audio-fft Cycles:10 Average:93.00 Median:74.00 stddev:38.67 (52.3%) stddev-sans-first:40.40 17:08:19 INFO - PID 31266 | Values: 74.0 74.0 77.0 174.0 76.0 74.0 74.0 74.0 158.0 75.0 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | [#4] audio-oscillator Cycles:10 Average:94.90 Median:79.00 stddev:25.24 (32.0%) stddev-sans-first:26.27 17:08:19 INFO - PID 31266 | Values: 81.0 79.0 127.0 78.0 79.0 80.0 136.0 79.0 79.0 131.0 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | [#5] imaging-gaussian-blur Cycles:10 Average:114.30 Median:114.00 stddev:0.82 (0.7%) stddev-sans-first:0.60 17:08:19 INFO - PID 31266 | Values: 116.0 115.0 114.0 114.0 114.0 114.0 115.0 113.0 114.0 114.0 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | [#6] imaging-darkroom Cycles:10 Average:151.00 Median:151.00 stddev:0.82 (0.5%) stddev-sans-first:0.78 17:08:19 INFO - PID 31266 | Values: 150.0 152.0 150.0 151.0 151.0 150.0 151.0 152.0 151.0 152.0 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | [#7] imaging-desaturate Cycles:10 Average:95.00 Median:95.00 stddev:0.67 (0.7%) stddev-sans-first:0.60 17:08:19 INFO - PID 31266 | Values: 96.0 95.0 95.0 95.0 96.0 95.0 95.0 95.0 94.0 94.0 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | [#8] json-parse-financial Cycles:10 Average:46.40 Median:45.50 stddev:3.20 (7.0%) stddev-sans-first:3.36 17:08:19 INFO - PID 31266 | Values: 45.0 44.0 45.0 48.0 45.0 46.0 45.0 55.0 46.0 45.0 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | [#9] json-stringify-tinderbox Cycles:10 Average:51.40 Median:51.50 stddev:0.52 (1.0%) stddev-sans-first:0.50 17:08:19 INFO - PID 31266 | Values: 52.0 51.0 52.0 52.0 52.0 51.0 51.0 51.0 51.0 51.0 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | [#10] stanford-crypto-aes Cycles:10 Average:75.20 Median:75.00 stddev:3.29 (4.4%) stddev-sans-first:3.49 17:08:19 INFO - PID 31266 | Values: 75.0 84.0 74.0 76.0 75.0 75.0 72.0 74.0 74.0 73.0 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | [#11] stanford-crypto-ccm Cycles:10 Average:122.90 Median:121.00 stddev:13.43 (11.1%) stddev-sans-first:14.24 17:08:19 INFO - PID 31266 | Values: 123.0 118.0 122.0 118.0 115.0 120.0 123.0 114.0 116.0 160.0 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:172.10 Median:173.50 stddev:7.75 (4.5%) stddev-sans-first:8.19 17:08:19 INFO - PID 31266 | Values: 174.0 188.0 166.0 173.0 181.0 167.0 169.0 167.0 174.0 162.0 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:62.50 Median:63.00 stddev:1.08 (1.7%) stddev-sans-first:1.00 17:08:19 INFO - PID 31266 | Values: 61.0 64.0 61.0 63.0 63.0 63.0 63.0 61.0 63.0 63.0 17:08:19 INFO - PID 31266 | -------- Summary: end -------- 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | ###!!! [Parent][MessageChannel] Error: (msgtype=0x150079,name=PBrowser::Msg_Destroy) Closed channel: cannot send/recv 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | ###!!! [Child][MessageChannel] Error: (msgtype=0x150001,name=PBrowser::Msg_AsyncMessage) Closed channel: cannot send/recv 17:08:19 INFO - PID 31266 | 17:08:19 INFO - PID 31266 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 17:08:20 INFO - TEST-INFO | 31266: exit 0 17:08:20 INFO - TEST-OK | kraken | took 60166ms 17:08:20 INFO - SUITE-END | took 1170s 17:08:20 INFO - Completed test suite (00:19:30) 17:08:20 INFO - javascript benchmark 17:08:20 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 8908.671874585676, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3822.8279727412264, 3828.7319887607878, 3888.1057356807933, 3926.4699265599133, 3932.7836968966703, 5931.940680593193, 6118.0, 6124.755009799608, 6152.477039451652, 6162.106494558287, 6017.157597936292, 6052.969735151329, 6083.78706745264, 6105.389461053893, 6135.8772824543485, 5435.755391007414, 5476.726163691809, 5478.233047373371, 5486.533644640191, 5505.532029777473, 5576.804811831586, 5593.161025846115, 5606.971965140168, 5629.268195134627, 5677.858053548653, 5470.17947307903, 5548.667079975195, 5591.524720398771, 5607.4672906074065, 5627.099664053752, 5375.838724838261, 5415.214793854909, 5425.077736784756, 5538.861528461821, 5549.112142057292, 5462.562994960394, 5485.561155107622, 5542.667439953575, 5558.082916318803, 5561.972190139064, 5925.377835327272, 5961.821145365646, 6016.458518733291, 6052.213212282375, 6091.908621370683, 6464.0, 6526.412622863965, 6540.018997150418, 6548.312427195171, 6558.376954189344, 6596.901046484307, 6616.20605527335, 6620.9006864897065, 6627.502937279675, 6689.130413046321, 6172.783952561684, 6177.4440300372735, 6200.255969283669, 6208.627482351028, 6223.502119830403, 6560.376764207393, 6751.5611485254285, 6784.321567843275, 6806.76176333826, 6818.965905170442, 6477.546571739933, 6478.384553467413, 6507.544471886922, 6550.836229094215, 6585.868282634417, 6513.511486638521, 6572.86854262912, 6602.405783479414, 6676.666166691646, 6681.432078273304, 6576.473882089422, 6581.835454113685, 6622.635755033423, 6627.403533681992, 6630.801075967729, 6545.672716364163, 6548.639824809681, 6626.86746265072, 6632.602043877383, 6666.533342666064, 4831.758412079382, 4884.12085824555, 4901.607871370282, 4956.702597844141, 4957.677750946177, 4442.600165985077, 4500.482444518857, 4536.6824322297125, 4545.340925565841, 4565.703229290086, 6085.939140608537, 6098.817035488943, 6178.6601736904, 6182.598131121463, 6200.968995155085, 6385.297617262097, 6473.417392434703, 6550.0829883816305, 6609.339066093448, 6614.470842332602, 6070.453659170607, 6188.164597779332, 6214.937850621526, 6227.595206311666, 6228.501719862491, 5401.7299135043095, 5426.104692725735, 5456.481634244819, 5501.284832971768, 5502.174673798882, 6812.659367031728, 6831.931680683129, 6886.449084073262, 6924.688389022506, 6942.514024018371, 6507.934920650733, 6533.738650453929, 6552.6068435894, 6579.901301480386, 6602.273749887412, 6787.389134977679, 6788.389044985975, 6884.862302754017, 6890.517663763489, 6918.619475928671, 6470.06184103293, 6488.188976377953, 6506.056621789909, 6605.834854128493, 6627.1716035495565, 6666.699998500176, 6681.131452911285, 6714.093597364488, 6727.024581435762, 6728.629925354153, 6294.622322660655, 6303.6532990685955, 6310.211223597051, 6381.1704478417505, 6398.232212134388, 6247.062940558771, 6300.369963003663, 6385.96807015962, 6395.552311338161, 6408.455281301141, 6266.0, 6285.402886725754, 6305.716242768995, 6385.074164246251, 6416.486681065597, 6441.0, 6442.710078046405, 6468.3855033771715, 6477.125588045742, 6520.608763474017, 6143.662098584442, 6174.104754810437, 6238.750449982132, 6247.968760156352, 6300.2754683212015], "value": 6051.6557059059505, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [932.7015355086371, 939.2439086535336, 960.4141473701042, 979.3780949097326, 992.3748038735596, 34482.48276275855, 42953.570464295386, 43625.34561981573, 43738.56261437385, 43868.78065609668, 44957.876053098604, 45189.548104518944, 45265.77367113168, 45281.54718452814, 45392.0, 7696.4227682923865, 7851.136374998746, 7852.725154619589, 7853.450258481908, 7861.017372828396, 7977.162397948219, 8054.798630034237, 8055.63749631268, 8058.315043221304, 8058.717944871931, 8104.837903241932, 8135.186481351847, 8150.592470376487, 8161.836763264731, 8165.265126138646, 8081.515109093473, 8121.675132994673, 8122.5126492410345, 8122.918770812275, 8128.187181281884, 7892.763217103496, 7941.6029198539845, 7979.4015448841565, 7989.520628762235, 8001.759947201535, 40426.39360409567, 41060.1787964242, 41373.79313103445, 41435.792821036004, 41436.1712765743, 3623.2572322673786, 3673.3938900081453, 3675.981620091909, 3679.300932822755, 3682.39240525313, 32873.17817054569, 32882.50676239858, 32931.176720581934, 32954.50568241478, 33003.0, 5285.550728188108, 5348.384935732402, 5354.063038968165, 5361.571074314045, 5400.027994960906, 221034.0, 221070.0, 221440.0, 223058.0, 223399.0, 51641.48358516442, 51742.0, 51812.22281665778, 51893.7405312971, 51907.74046129745, 54399.0, 54530.0, 54586.18120728192, 54595.0, 54626.453735462135, 15262.0, 15503.84496155024, 16705.91647041757, 16796.664066718597, 16925.492235232963, 13648.112872663245, 13727.656808579866, 13734.862651373558, 13738.65653358674, 13761.862381376259, 15728.370865165494, 15827.129507877178, 15851.762223566655, 15871.365145394286, 15876.364945402285, 6380.776672816429, 6417.133686952295, 6467.385598368148, 6478.222613286436, 6497.15536980199, 1067.8344856547249, 1069.3690722473777, 1070.0786851894372, 1081.8431327457474, 1082.2965072702648, 24467.65427901447, 24745.246008146347, 24756.13353532654, 24846.37884052913, 24857.282824950362, 1176.8705442401329, 1180.740237147826, 1196.8503937007874, 1197.3594127141937, 1199.8500187476566, 16573.91713041427, 16833.915830421014, 16859.0, 17070.914645426692, 17266.0, 302252.0, 304370.0, 304811.0, 307076.0, 307133.0, 64361.67819160874, 65231.67384163049, 65352.0, 65367.0, 65680.34319656742, 1508.7585986242148, 1524.7179271834746, 1541.2987090873626, 1552.1773460066183, 1566.3264796137541, 28365.149045528666, 28454.71545284521, 29088.272793179494, 29435.558466623446, 29485.557716633837, 42674.78662606667, 42952.0, 43033.0, 43055.13889722125, 43055.354169686856, 246738.0, 247135.0, 247160.0, 247559.0, 248681.0, 36110.819445902605, 37840.43239351357, 39501.802490987364, 39881.2023759529, 39975.80012099921, 49753.25370119379, 51317.7434112827, 51429.742851285504, 51654.48345516497, 51755.0, 31196.532052018785, 31247.598469008506, 31486.84256578794, 31731.20671983219, 31861.20346991251, 30468.542971855884, 30730.385392292475, 31055.378892422475, 31285.217869553442, 31331.21671958128, 41008.0, 41056.38415423831, 41273.79363103165, 41276.0, 41283.0, 30906.845465772527, 31225.0, 31292.217694557818, 31424.52863207008, 32070.83964580162, 25622.61566076473, 26302.736972630795, 26437.0, 26580.20259392144, 26971.190864274104], "value": 18812.281606454464, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [571.3320482502335, 572.1589263782239, 584.5323741007193, 592.6532978207748, 596.6569222696949, 23501.647475287864, 24207.75792242079, 24246.0, 24251.636225456634, 24267.150649727264, 23906.88046559765, 26250.0, 26329.210123696274, 26496.867515662394, 26529.734702652968, 6297.779577714769, 6451.129097571815, 6458.677066146697, 6468.223813142429, 6481.416672499474, 5908.911366329487, 6127.662978536178, 6352.6188428694195, 6388.744450221986, 6397.232332120128, 6093.238345206849, 6107.144999700045, 6112.174856394397, 6115.174451449042, 6116.571839971204, 6076.635401875901, 6085.513158947318, 6085.786997455112, 6088.969555152218, 6111.327753947062, 5643.971780141114, 5654.519365853907, 5663.235463212455, 5676.460736230093, 5730.541556675456, 30114.548281775573, 30622.0, 30971.53542696839, 31096.689033109833, 31489.8425507871, 2212.4579478027827, 2267.6031694453404, 2268.2288022072407, 2268.8184945204507, 2270.3189043286948, 20354.898225508925, 20981.26565570213, 20984.790152098438, 21013.894930525403, 21036.684449733268, 2432.5013372258823, 2463.642771798079, 2524.684414448194, 2526.166365099513, 2533.290678609974, 139660.0, 145653.0, 146341.0, 146464.0, 147040.0, 14915.776263356058, 15260.100580889595, 15316.463923762614, 15822.446214382442, 15966.76049859253, 24547.140850070162, 24972.250832475056, 25154.748452515607, 25256.747432525808, 25309.22835401541, 10731.570737170427, 10806.675799726021, 10824.296420732628, 10980.725481863017, 11168.106551475863, 10123.64567240143, 10154.238432117621, 10168.542415591317, 10184.949075254577, 10234.744131396774, 9839.0, 9861.556229969668, 9911.80176396468, 10081.69754907354, 10208.234382421348, 2646.1025177430683, 2669.9466010679675, 2750.518659234626, 2776.2093449725216, 2910.8356657337235, 992.7418871093423, 993.4883534979491, 1028.3521381529588, 1029.6087486754984, 1031.4636389077637, 20584.897075514527, 20636.17455301771, 20722.274720384714, 20804.687929681066, 21329.893350533148, 1065.7921705267554, 1068.941208233539, 1074.258761454594, 1083.4474418046852, 1097.4567589043315, 11350.205485615928, 11494.080473562095, 11573.132015098901, 11628.76742465146, 11719.828017198382, 625946.0, 628694.0, 629285.0, 654573.0, 710978.0, 133656.0, 137629.0, 138724.0, 139260.0, 139280.0, 1286.1125823181974, 1286.3761075878192, 1324.3643051335414, 1325.9867401325864, 1336.2316667915793, 21181.36455906325, 21425.142994280053, 21496.24763133283, 22100.2264920727, 22364.329070127922, 62440.0, 66549.33450665431, 66912.6654366725, 67880.0, 69253.65373173101, 80311.59844200741, 80782.59608701919, 81323.18676813156, 81531.59234203791, 81768.59115704383, 15160.469383571522, 15736.606584835014, 15737.68524629524, 15748.291326890547, 15845.445409410615, 24747.62878556859, 25018.874905625355, 25105.372365691004, 25133.37166570777, 25146.24561263165, 18549.35077272289, 19462.31881884127, 19672.0, 19970.201191952157, 19995.200191992157, 16349.591260218589, 16802.66394672124, 16825.326986920387, 17124.315027398763, 17622.207000684743, 19661.606767864847, 20293.188272469528, 20511.4872128198, 20696.17215311371, 20705.58588828245, 15511.22443877779, 15549.378024878879, 15622.765658514903, 15667.686646267239, 15705.822063345066, 18171.454856354332, 18445.631087378446, 18491.167897444917, 18575.81424185795, 18621.81378186201], "value": 12689.878395861844, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1442.7330943775403, 1484.2578710644677, 1486.5094518808794, 1514.8030756001722, 1521.262187838898, 15557.92221038896, 16135.757963630555, 16224.513264602052, 16230.83769162308, 16243.675126497477, 15763.133027683472, 15795.289211985459, 15897.12565808883, 15929.52211433656, 15933.601659958507, 2578.961315580263, 2601.8959241630314, 2639.3401649587604, 2676.638653781734, 2725.168823508829, 2554.463562651845, 2624.6325514427995, 2646.775024122952, 2661.2149415922254, 2714.3892624159603, 2483.279848843842, 2579.9097031603897, 2581.8967241310324, 2601.947961040778, 2646.6691663542056, 2531.392465808211, 2540.517301712678, 2555.527227462925, 2563.7436256374494, 2601.2456387647558, 2613.5426300397353, 2767.8892844286206, 2768.349437882096, 2769.6399468069226, 2772.7088655691064, 15884.04695718249, 16075.0, 16118.355265789472, 16125.758113628304, 16133.274002669908, 7995.720149794787, 8291.709790157376, 8303.792405189859, 8312.501249925024, 8316.501009939422, 5117.309163262949, 5370.946290537084, 5447.455254474521, 5503.587230957694, 5504.0, 1901.1539864760186, 1943.4055535859645, 1943.6987266973642, 1966.6263409952064, 1975.1605567633699, 27771.778257739334, 28156.859215703997, 28386.432271354457, 28447.288817779514, 28514.287142821388, 7003.669302832445, 7101.751438699621, 7145.749898753519, 7173.461990350745, 7452.06849143857, 18296.63406731858, 18300.90849545744, 18491.907540462482, 18520.073996300132, 18581.25674973013, 8325.167483251747, 8373.204545568162, 8378.12029736881, 8381.916180838114, 8483.406161568755, 7567.545947243183, 7737.0715514138665, 7776.883346749803, 7818.569978651115, 7832.569208693577, 5703.600747947687, 5824.446677565625, 5884.205632239678, 5922.466977971917, 6085.330613632497, 1763.7795275590552, 1817.5546990987293, 1825.7443957845912, 1849.537615596101, 1855.1373611270824, 938.8591711243231, 993.5975929748463, 995.9402435853872, 996.6960077176531, 1006.1548299428515, 8301.46040507365, 8316.5425901576, 8458.619362128718, 8459.111793261742, 8512.957435212784, 745.7725393754957, 747.7158679701679, 749.7759633575603, 760.1068744225513, 765.8276887700223, 5539.623697279105, 5672.5745569081655, 5774.595778295479, 5841.9415805842245, 5979.983402821531, 22293.108275669118, 22686.886565567067, 23039.193628222933, 23319.53360932772, 23444.531109377716, 23211.303660889862, 23370.64944025841, 23478.0, 23587.056517739442, 23592.528149437258, 11054.613088542023, 11658.708532286591, 11666.766664666658, 11872.22830516031, 11970.700732481584, 9345.48599827016, 9455.952720236355, 9541.332106752738, 9880.35777674449, 9916.256280779115, 19741.802581973996, 20033.799662003777, 20085.698714519585, 20410.693839592714, 21124.577508450053, 20313.49216269546, 20649.27727529529, 20751.584968300853, 20893.26873559479, 21044.68432973476, 12781.297028663514, 13121.606351809462, 13127.474901003852, 13131.34343282813, 13144.0, 14635.707285854436, 14682.0, 14688.632784180054, 14819.40722371093, 14829.925850370679, 10957.232993690364, 11233.213675042996, 11309.660710178709, 11462.94268528652, 11480.598179063692, 11020.173486988668, 11059.668209953714, 11129.83305250438, 11243.718907027063, 11425.14311426663, 9282.489463079595, 9364.110409511086, 10507.211959102944, 10661.840072398765, 10774.946125269636, 7965.359347003737, 7973.920260797549, 8008.399370047153, 8033.156518565466, 8149.551774652451, 7923.920760792549, 7968.521888686466, 7990.6004699765945, 7997.800054998672, 8053.597320134087], "value": 6988.859455665596, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [534.9197620356946, 542.1596525385656, 563.8533981164899, 565.2736233939387, 571.9313682358115, 5994.9999999999945, 6046.576739628223, 6068.757249710012, 6101.603395779282, 6115.266168059828, 5992.741524279895, 5996.880062398749, 6032.87934241316, 6038.033914573669, 6062.0, 4950.480199579047, 4961.189165954419, 4998.625103117262, 5012.774425150877, 5012.799488020493, 4736.9526304736855, 4924.162892308298, 4971.37857767779, 4974.42794078682, 5022.17134172861, 4763.90472190556, 4792.712437253758, 4799.520047995207, 4829.0, 4836.0, 4781.306710526971, 4792.472827988919, 4824.396950381202, 4862.756862156878, 4881.60874150867, 4268.701190916637, 4352.73883566987, 4378.365137055109, 4396.274614688573, 4397.9560204398185, 5868.794592189253, 5869.354371019184, 5895.852603684899, 5899.056151015817, 5900.1739756434135, 5527.060399732015, 5574.777008919679, 5593.105103183471, 5639.492445679908, 5651.8304450866535, 6402.583832050948, 6410.615363078184, 6419.293877673452, 6440.0, 6457.709403076873, 4837.7339246341435, 4853.466118726938, 4859.271109333593, 4861.683990540603, 4891.1195984722735, 6395.296517383084, 6456.3220861809305, 6471.320511346288, 6629.469642428594, 6667.19993600771, 4968.633625752875, 4971.055499455092, 4971.1797553403285, 5000.224965130411, 5013.498650134958, 5008.91951449863, 5015.27278544609, 5037.798488060436, 5056.570191533688, 5081.390233172043, 5556.305461817273, 5579.553635709133, 5585.357683866408, 5601.5238704709745, 5605.5515558755205, 6385.0, 6408.423241908251, 6431.163948686641, 6443.903341449882, 6466.288708242089, 1737.4440179142805, 1744.3981826269917, 1746.3974928649595, 1756.8945863248246, 1760.9698326478897, 1190.833283340333, 1222.7554489102215, 1245.937972655257, 1246.5013994402311, 1251.443107817031, 6016.819495415145, 6060.636361818305, 6066.66633335162, 6081.331053584102, 6134.35589263121, 6406.711697973602, 6475.611463312216, 6491.902621460682, 6544.509161812883, 6555.180602424697, 5911.788083442884, 5959.344472108065, 5969.791057312973, 5980.671063091485, 6041.0, 3372.780769249991, 3412.948805767866, 3426.5716785401823, 3436.106612280775, 3443.8794642187404, 6841.760538381132, 6857.794266172023, 6866.622335771581, 6884.070650462124, 6897.3447522485285, 6654.037059067587, 6718.514149764618, 6719.092922455406, 6725.8654826903185, 6731.966340168267, 6776.254611992578, 6842.452603791585, 6867.175938887365, 6930.203026651899, 6939.968522820915, 5970.238779559953, 6463.935360646334, 6478.676066196577, 6482.643454610042, 6555.4427873629365, 6388.55280130405, 6444.0, 6446.387593178641, 6473.967630161819, 6480.384363485461, 6771.52599318043, 6877.759278425231, 6919.37725604698, 6933.2026816916705, 6947.93052069493, 4895.545054000842, 4929.556339929423, 4948.406191256928, 4953.479884612064, 4988.725620090785, 6372.681365931592, 6377.521685873671, 6523.869522609616, 6556.8360790980605, 6623.536352455282, 6123.326434092157, 6339.778107766206, 6343.207099112611, 6371.362863713592, 6386.648734319657, 6358.554901156875, 6373.203349581302, 6384.808455746335, 6408.743650254124, 6420.678966051585, 6348.523860710373, 6374.139491168633, 6390.329015453311, 6414.390632889868, 6421.325760795049, 6442.452391546583, 6442.581232219891, 6455.580387274812, 6478.578892371981, 6481.902771458526, 6269.780557680641, 6274.341194174546, 6284.120223168668, 6293.937060629335, 6295.307516173309], "value": 5013.299650443537, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [952.3000594562996, 978.1196922769507, 1000.4897502273839, 1006.3408467453811, 1009.1170226052204, 17236.48290551284, 17941.820581794178, 17975.10124493775, 18016.18927148278, 20805.0, 21085.156593736232, 21452.785472145275, 21480.57038859222, 21481.46296342592, 21703.565928681415, 992.0823238504373, 1010.7927874785652, 1015.1675625986694, 1019.7399663085903, 1029.3566520924421, 971.2666936462961, 1056.1234175634206, 1066.7119877633033, 1078.8435676826855, 1079.7624522605015, 1137.2550979108655, 1144.7939370913232, 1145.34715212329, 1146.5070019891443, 1147.1969621265107, 1134.024738724692, 1134.9092072634169, 1136.494260054276, 1136.8806275341094, 1139.1627154041773, 838.4759525296689, 838.4801423117706, 838.5974732128612, 838.9077201507829, 839.1943734015352, 19303.806961930342, 20256.79743202564, 20337.898310508353, 20507.0, 20508.897455512775, 21263.68104478434, 21395.786042139534, 21511.892440537853, 21671.133154673793, 21808.345749627537, 17425.47723568295, 17509.212085456184, 17750.822491775045, 17823.376181833573, 18008.549786255448, 3897.3179693553516, 3906.3359228930867, 3911.432842237888, 3917.4515567820526, 3917.490726205575, 134650.0, 136527.0, 138681.0, 138935.0, 142099.57900420966, 16666.166691665367, 16920.40778572744, 17037.829621703626, 17087.145642717813, 17096.82903170977, 31791.364172716418, 33185.336293274, 33383.0, 33430.66569334324, 33438.331233375684, 8155.959220203979, 9186.86219706705, 9802.705918822447, 9805.264605154642, 9924.057214564606, 4693.507181745936, 4797.016611594615, 4817.494163112893, 4820.108279968217, 4836.927446088312, 5514.5864060195645, 5536.612437129443, 5595.804146854841, 5626.971865140648, 5669.716514174274, 1155.7977353963022, 1176.588194132047, 1190.458341454636, 1190.458341454636, 1194.6117511808523, 739.2348918868945, 744.0959234530072, 755.4258763339791, 766.2490759056157, 781.5896654256447, 12615.549211840573, 13004.349782511026, 13107.672308192181, 13313.733725325439, 13582.388792504362, 743.18992298395, 748.831512909591, 749.8387846612895, 767.8464307138482, 771.9614019299013, 6023.6385816851125, 6079.544034197453, 6143.600665956698, 6178.783742568989, 6179.258488981351, 128443.0, 129729.0, 130101.34949325382, 131335.0, 134350.32824836008, 117002.41498792451, 118496.40751796185, 119401.40299298622, 119998.0, 123775.0, 101358.4932075335, 102562.0, 102696.48651756694, 104371.0, 104425.0, 11434.542618295174, 11579.478923448296, 11689.240199387013, 11993.76012479728, 12005.75988480208, 49014.75492622514, 49192.0, 49966.75016624894, 50246.7487662574, 51843.22235166551, 63880.68059659672, 64231.67884160549, 64417.67791161014, 65544.67227663832, 65696.01455978259, 15672.451464198699, 15775.132367719885, 16082.919585401998, 16149.111798851176, 16374.590635234214, 22477.550448991256, 22503.549929001, 22561.43596410103, 22628.981695824055, 22808.771912280667, 20017.199312027355, 20376.0, 20377.0, 20526.0, 20551.177952881717, 20149.798502014793, 20200.89899550493, 20454.488637784176, 20459.181632734522, 20479.078441469872, 20674.173033078507, 20882.0, 21102.47243818917, 21258.78741212568, 21720.456988575414, 13331.200127992352, 14238.359273832495, 14328.785068224193, 14525.418983240552, 14570.271486425849, 15166.24168791578, 15442.922785386001, 15933.60165995813, 16020.839791601935, 16728.916355418143], "value": 9875.187449548226, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1486.3, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 107.0, 99.0, 105.0, 107.0, 108.0, 111.0, 99.0, 107.0, 109.0], "value": 104.8, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 115.0, 141.0, 166.0, 116.0, 146.0, 141.0, 120.0, 165.0, 124.0], "value": 138.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [168.0, 165.0, 164.0, 163.0, 161.0, 164.0, 160.0, 161.0, 166.0, 176.0], "value": 164.8, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 74.0, 77.0, 174.0, 76.0, 74.0, 74.0, 74.0, 158.0, 75.0], "value": 93.0, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 79.0, 127.0, 78.0, 79.0, 80.0, 136.0, 79.0, 79.0, 131.0], "value": 94.9, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [116.0, 115.0, 114.0, 114.0, 114.0, 114.0, 115.0, 113.0, 114.0, 114.0], "value": 114.3, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [150.0, 152.0, 150.0, 151.0, 151.0, 150.0, 151.0, 152.0, 151.0, 152.0], "value": 151.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 95.0, 95.0, 95.0, 96.0, 95.0, 95.0, 95.0, 94.0, 94.0], "value": 95.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [45.0, 44.0, 45.0, 48.0, 45.0, 46.0, 45.0, 55.0, 46.0, 45.0], "value": 46.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [52.0, 51.0, 52.0, 52.0, 52.0, 51.0, 51.0, 51.0, 51.0, 51.0], "value": 51.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 84.0, 74.0, 76.0, 75.0, 75.0, 72.0, 74.0, 74.0, 73.0], "value": 75.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [123.0, 118.0, 122.0, 118.0, 115.0, 120.0, 123.0, 114.0, 116.0, 160.0], "value": 122.9, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [174.0, 188.0, 166.0, 173.0, 181.0, 167.0, 169.0, 167.0, 174.0, 162.0], "value": 172.1, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [61.0, 64.0, 61.0, 63.0, 63.0, 63.0, 63.0, 61.0, 63.0, 63.0], "value": 62.5, "unit": "score"}]}]} 17:08:20 INFO - Return code: 0 17:08:20 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 17:08:20 INFO - # TBPL SUCCESS # 17:08:20 INFO - Running post-action listener: _package_coverage_data 17:08:20 INFO - Running post-action listener: _resource_record_post_action 17:08:20 INFO - [mozharness: 2017-08-23 00:08:20.861757Z] Finished run-tests step (success) 17:08:20 INFO - Running post-run listener: _resource_record_post_run 17:08:20 INFO - Total resource usage - Wall time: 1189s; CPU: 13.0%; Read bytes: 12288; Write bytes: 428056576; Read time: 412; Write time: 313744 17:08:20 INFO - TinderboxPrint: CPU usage
13.1% 17:08:20 INFO - TinderboxPrint: I/O read bytes / time
12,288 / 412 17:08:20 INFO - TinderboxPrint: I/O write bytes / time
428,056,576 / 313,744 17:08:20 INFO - TinderboxPrint: CPU idle
8,239.3 (86.9%) 17:08:20 INFO - TinderboxPrint: CPU user
1,190.0 (12.6%) 17:08:20 INFO - TinderboxPrint: Swap in / out
0 / 0 17:08:20 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 0; Write bytes: 109322240; Read time: 0; Write time: 114028 17:08:20 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 17:08:20 INFO - run-tests - Wall time: 1171s; CPU: 13.0%; Read bytes: 12288; Write bytes: 318193664; Read time: 412; Write time: 199712 17:08:21 INFO - Running post-run listener: _upload_blobber_files 17:08:21 INFO - Blob upload gear active. 17:08:21 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 17:08:21 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 17:08:21 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 17:08:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 17:08:21 INFO - (blobuploader) - INFO - Open directory for files ... 17:08:21 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 17:08:21 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:08:21 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:08:23 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 17:08:23 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:08:23 INFO - (blobuploader) - INFO - Done attempting. 17:08:23 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 17:08:23 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:08:23 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:08:30 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 17:08:30 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:08:30 INFO - (blobuploader) - INFO - Done attempting. 17:08:30 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 17:08:30 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:08:30 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:08:32 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 17:08:32 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:08:32 INFO - (blobuploader) - INFO - Done attempting. 17:08:32 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 17:08:32 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:08:32 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:08:32 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 17:08:32 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:08:32 INFO - (blobuploader) - INFO - Done attempting. 17:08:32 INFO - (blobuploader) - INFO - Iteration through files over. 17:08:32 INFO - Return code: 0 17:08:32 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 17:08:32 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 17:08:32 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/0c7138ddd112c6d8bead92f14eedfe954c32ea290502b2ee2f83dcc6b99cf0bf4ceec6bab14ef7dfc09578a1e105af92a181f8b3bb163b71e2b906d8549aee87", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/97d9afc8c07fd375d5db3ef9118b1d0a49535c280aef09b5d44b51d4ab1f928471a62e75bb44b24125e4aa099fd0dc0e419f565f142c993691a437e2c613a043", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ce66913b0d36fab9a8dd707b2558b3b8998d942292ff35ca538a6f9312f923340129790e4d26c859476f3cbcb65ae414be3c9215d526db0356fc4ec7b51c8992", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f3677b1654291ab3534ec014d5a27a72dd085476ba55231c94ba8bf5926e310abe0eb310b41b83e997486d950fe5637b20f8a51f65f792cf7819124d9649a092"} 17:08:32 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 17:08:32 INFO - Writing to file /builds/slave/test/properties/blobber_files 17:08:32 INFO - Contents: 17:08:32 INFO - blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/0c7138ddd112c6d8bead92f14eedfe954c32ea290502b2ee2f83dcc6b99cf0bf4ceec6bab14ef7dfc09578a1e105af92a181f8b3bb163b71e2b906d8549aee87", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/97d9afc8c07fd375d5db3ef9118b1d0a49535c280aef09b5d44b51d4ab1f928471a62e75bb44b24125e4aa099fd0dc0e419f565f142c993691a437e2c613a043", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ce66913b0d36fab9a8dd707b2558b3b8998d942292ff35ca538a6f9312f923340129790e4d26c859476f3cbcb65ae414be3c9215d526db0356fc4ec7b51c8992", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f3677b1654291ab3534ec014d5a27a72dd085476ba55231c94ba8bf5926e310abe0eb310b41b83e997486d950fe5637b20f8a51f65f792cf7819124d9649a092"} 17:08:32 INFO - Running post-run listener: copy_logs_to_upload_dir 17:08:32 INFO - Copying logs to upload dir... 17:08:32 INFO - mkdir: /builds/slave/test/build/upload/logs 17:08:32 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1251.804339 ========= master_lag: -0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 51 secs) (at 2017-08-22 17:08:32.674445) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-08-22 17:08:32.677843) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/0c7138ddd112c6d8bead92f14eedfe954c32ea290502b2ee2f83dcc6b99cf0bf4ceec6bab14ef7dfc09578a1e105af92a181f8b3bb163b71e2b906d8549aee87", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/97d9afc8c07fd375d5db3ef9118b1d0a49535c280aef09b5d44b51d4ab1f928471a62e75bb44b24125e4aa099fd0dc0e419f565f142c993691a437e2c613a043", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ce66913b0d36fab9a8dd707b2558b3b8998d942292ff35ca538a6f9312f923340129790e4d26c859476f3cbcb65ae414be3c9215d526db0356fc4ec7b51c8992", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f3677b1654291ab3534ec014d5a27a72dd085476ba55231c94ba8bf5926e310abe0eb310b41b83e997486d950fe5637b20f8a51f65f792cf7819124d9649a092"} build_url:https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011467 build_url: 'https://queue.taskcluster.net/v1/task/LYBzTNi1T0ybIZwpNEaiNg/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/0c7138ddd112c6d8bead92f14eedfe954c32ea290502b2ee2f83dcc6b99cf0bf4ceec6bab14ef7dfc09578a1e105af92a181f8b3bb163b71e2b906d8549aee87", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/97d9afc8c07fd375d5db3ef9118b1d0a49535c280aef09b5d44b51d4ab1f928471a62e75bb44b24125e4aa099fd0dc0e419f565f142c993691a437e2c613a043", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ce66913b0d36fab9a8dd707b2558b3b8998d942292ff35ca538a6f9312f923340129790e4d26c859476f3cbcb65ae414be3c9215d526db0356fc4ec7b51c8992", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f3677b1654291ab3534ec014d5a27a72dd085476ba55231c94ba8bf5926e310abe0eb310b41b83e997486d950fe5637b20f8a51f65f792cf7819124d9649a092"}' ========= master_lag: 0.13 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-08-22 17:08:32.818999) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-08-22 17:08:32.819320) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1503445657.981545-2048041063 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004510 ========= master_lag: 0.01 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-08-22 17:08:32.837159) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-08-22 17:08:32.837455) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-08-22 17:08:32.837716) ========= ========= Total master_lag: 0.20 =========